builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-048 starttime: 1455606326.29 results: success (0) buildid: 20160215203228 builduid: 0c16c316b3854e2da497e5ec180de72a revision: fb7ceaf4b009243423cdaf1077adbb6c609b22e5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.285871) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.286226) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.286515) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006349 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.321193) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.321521) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.345127) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.345391) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004706 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.394694) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.394993) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.395347) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.395638) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-15 23:05:27-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-02-15 23:05:27 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.221750 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.629240) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.629567) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017170 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.680080) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:26.680441) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev fb7ceaf4b009243423cdaf1077adbb6c609b22e5 --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/fx-team --rev fb7ceaf4b009243423cdaf1077adbb6c609b22e5 --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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-15 23:05:27,718 truncating revision to first 12 chars 2016-02-15 23:05:27,718 Setting DEBUG logging. 2016-02-15 23:05:27,718 attempt 1/10 2016-02-15 23:05:27,718 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/fb7ceaf4b009?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-15 23:05:27,953 unpacking tar archive at: fx-team-fb7ceaf4b009/testing/mozharness/ program finished with exit code 0 elapsedTime=0.499934 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:27.193343) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:27.193654) ========= echo fb7ceaf4b009243423cdaf1077adbb6c609b22e5 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'fb7ceaf4b009243423cdaf1077adbb6c609b22e5'] 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False fb7ceaf4b009243423cdaf1077adbb6c609b22e5 program finished with exit code 0 elapsedTime=0.004660 script_repo_revision: 'fb7ceaf4b009243423cdaf1077adbb6c609b22e5' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:27.242738) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:27.243032) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-15 23:05:27.256296) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-02-15 23:05:27.256579) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:05:28 INFO - MultiFileLogger online at 20160215 23:05:28 in /builds/slave/test-pgo 23:05:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 23:05:28 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 23:05:28 INFO - {'append_to_log': False, 23:05:28 INFO - 'base_work_dir': '/builds/slave/test-pgo', 23:05:28 INFO - 'blob_upload_branch': 'Fx-Team', 23:05:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 23:05:28 INFO - 'branch': 'Fx-Team', 23:05:28 INFO - 'buildbot_json_path': 'buildprops.json', 23:05:28 INFO - 'config_files': ('talos/linux_config.py',), 23:05:28 INFO - 'default_actions': ('clobber', 23:05:28 INFO - 'read-buildbot-config', 23:05:28 INFO - 'download-and-extract', 23:05:28 INFO - 'populate-webroot', 23:05:28 INFO - 'create-virtualenv', 23:05:28 INFO - 'install', 23:05:28 INFO - 'run-tests'), 23:05:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:05:28 INFO - 'download_minidump_stackwalk': True, 23:05:28 INFO - 'download_symbols': 'ondemand', 23:05:28 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:05:28 INFO - 'tooltool.py': '/tools/tooltool.py', 23:05:28 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:05:28 INFO - '/tools/misc-python/virtualenv.py')}, 23:05:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:05:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:05:28 INFO - 'installer_path': 'installer.exe', 23:05:28 INFO - 'log_level': 'info', 23:05:28 INFO - 'log_name': 'talos', 23:05:28 INFO - 'log_to_console': True, 23:05:28 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:05:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:05:28 INFO - 'opt_config_files': (), 23:05:28 INFO - 'pip_index': False, 23:05:28 INFO - 'sps_profile': False, 23:05:28 INFO - 'sps_profile_interval': 0, 23:05:28 INFO - 'suite': 'dromaeojs', 23:05:28 INFO - 'system_bits': '32', 23:05:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:05:28 INFO - 'title': 'talos-linux64-ix-048', 23:05:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:05:28 INFO - 'use_talos_json': True, 23:05:28 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 23:05:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:05:28 INFO - 'work_dir': 'build'} 23:05:28 INFO - ##### 23:05:28 INFO - ##### Running clobber step. 23:05:28 INFO - ##### 23:05:28 INFO - Running pre-action listener: _resource_record_pre_action 23:05:28 INFO - Running main action method: clobber 23:05:28 INFO - rmtree: /builds/slave/test-pgo/build 23:05:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 23:05:29 INFO - Running post-action listener: _resource_record_post_action 23:05:29 INFO - ##### 23:05:29 INFO - ##### Running read-buildbot-config step. 23:05:29 INFO - ##### 23:05:29 INFO - Running pre-action listener: _resource_record_pre_action 23:05:29 INFO - Running main action method: read_buildbot_config 23:05:29 INFO - Using buildbot properties: 23:05:29 INFO - { 23:05:29 INFO - "project": "", 23:05:29 INFO - "product": "firefox", 23:05:29 INFO - "script_repo_revision": "production", 23:05:29 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 23:05:29 INFO - "repository": "", 23:05:29 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 23:05:29 INFO - "buildid": "20160215203228", 23:05:29 INFO - "pgo_build": "True", 23:05:29 INFO - "basedir": "/builds/slave/test-pgo", 23:05:29 INFO - "buildnumber": 945, 23:05:29 INFO - "slavename": "talos-linux64-ix-048", 23:05:29 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 23:05:29 INFO - "platform": "ubuntu64_hw", 23:05:29 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 23:05:29 INFO - "branch": "fx-team", 23:05:29 INFO - "repo_path": "integration/fx-team", 23:05:29 INFO - "revision": "fb7ceaf4b009243423cdaf1077adbb6c609b22e5", 23:05:29 INFO - "stage_platform": "linux64-pgo", 23:05:29 INFO - "builduid": "0c16c316b3854e2da497e5ec180de72a", 23:05:29 INFO - "slavebuilddir": "test" 23:05:29 INFO - } 23:05:29 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 23:05:29 INFO - Running post-action listener: _resource_record_post_action 23:05:29 INFO - ##### 23:05:29 INFO - ##### Running download-and-extract step. 23:05:29 INFO - ##### 23:05:29 INFO - Running pre-action listener: _resource_record_pre_action 23:05:29 INFO - Running main action method: download_and_extract 23:05:29 INFO - mkdir: /builds/slave/test-pgo/build/tests 23:05:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:29 INFO - https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 23:05:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/test_packages.json 23:05:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/test_packages.json 23:05:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 23:05:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 23:05:34 INFO - Downloaded 1448 bytes. 23:05:34 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 23:05:34 INFO - Using the following test package requirements: 23:05:34 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:05:34 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:05:34 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:05:34 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'jsshell-linux-x86_64.zip'], 23:05:34 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:05:34 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:05:34 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:05:34 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:05:34 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:05:34 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:05:34 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:05:34 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:05:34 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:05:34 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')]} 23:05:34 INFO - https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:05:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:05:39 INFO - Downloaded 23342450 bytes. 23:05:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:05:39 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:05:40 INFO - Return code: 0 23:05:40 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:05:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:40 INFO - https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:05:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:05:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:05:42 INFO - Downloaded 23342450 bytes. 23:05:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:05:42 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:05:43 INFO - Return code: 0 23:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:43 INFO - https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:05:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:05:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:05:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:05:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:05:44 INFO - Downloaded 10707070 bytes. 23:05:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:05:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 23:05:44 INFO - Return code: 0 23:05:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:44 INFO - https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:05:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:05:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:05:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:05:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:05:46 INFO - Downloaded 56561391 bytes. 23:05:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:05:46 INFO - mkdir: /builds/slave/test-pgo/properties 23:05:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 23:05:46 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 23:05:46 INFO - Contents: 23:05:46 INFO - build_url:https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:05:47 INFO - Running post-action listener: _resource_record_post_action 23:05:47 INFO - Running post-action listener: set_extra_try_arguments 23:05:47 INFO - ##### 23:05:47 INFO - ##### Running populate-webroot step. 23:05:47 INFO - ##### 23:05:47 INFO - Running pre-action listener: _resource_record_pre_action 23:05:47 INFO - Running main action method: populate_webroot 23:05:47 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:05:47 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:05:47 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:05:47 INFO - '--tppagecycles', 23:05:47 INFO - '7'], 23:05:47 INFO - 'tests': ['tsvgm']}}, 23:05:47 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 23:05:47 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:05:47 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 23:05:47 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:05:47 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:05:47 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:05:47 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'tests': ['damp', 'tps']}, 23:05:47 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['damp', 'tps']}, 23:05:47 INFO - 'g3': {'tests': ['dromaeo_dom']}, 23:05:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:05:47 INFO - 'other': {'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'other-e10s': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'other_l64': {'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'other_nol64': {'tests': ['a11yr', 23:05:47 INFO - 'ts_paint', 23:05:47 INFO - 'tpaint', 23:05:47 INFO - 'sessionrestore', 23:05:47 INFO - 'sessionrestore_no_auto_restore']}, 23:05:47 INFO - 'svgr': {'tests': ['tsvgx', 23:05:47 INFO - 'tsvgr_opacity', 23:05:47 INFO - 'tart', 23:05:47 INFO - 'tscrollx', 23:05:47 INFO - 'cart']}, 23:05:47 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['tsvgx', 23:05:47 INFO - 'tsvgr_opacity', 23:05:47 INFO - 'tart', 23:05:47 INFO - 'tscrollx', 23:05:47 INFO - 'cart']}, 23:05:47 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'tests': ['tp5o']}, 23:05:47 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'talos_options': ['--e10s'], 23:05:47 INFO - 'tests': ['tp5o']}, 23:05:47 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'talos_options': ['--xperf_path', 23:05:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:05:47 INFO - 'tests': ['tp5n']}, 23:05:47 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:05:47 INFO - 'talos_options': ['--e10s', 23:05:47 INFO - '--xperf_path', 23:05:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:05:47 INFO - 'tests': ['tp5n']}}, 23:05:47 INFO - 'talos.zip': {'path': '', 23:05:47 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:05:47 INFO - Running post-action listener: _resource_record_post_action 23:05:47 INFO - ##### 23:05:47 INFO - ##### Running create-virtualenv step. 23:05:47 INFO - ##### 23:05:47 INFO - Running pre-action listener: _resource_record_pre_action 23:05:47 INFO - Running main action method: create_virtualenv 23:05:47 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 23:05:47 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 23:05:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 23:05:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:05:47 INFO - Using real prefix '/usr' 23:05:47 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 23:05:47 INFO - Installing distribute.............................................................................................................................................................................................done. 23:05:49 INFO - Installing pip.................done. 23:05:49 INFO - Return code: 0 23:05:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 23:05:49 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')]} 23:05:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:05:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:49 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')]} 23:05:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:05:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:49 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:05:49 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 23:05:49 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 23:05:49 INFO - Using env: {'DISPLAY': ':0', 23:05:49 INFO - 'HOME': '/home/cltbld', 23:05:49 INFO - 'LANG': 'en_US.UTF-8', 23:05:49 INFO - 'LANGUAGE': 'en_US:en', 23:05:49 INFO - 'LOGNAME': 'cltbld', 23:05:49 INFO - 'MAIL': '/var/mail/cltbld', 23:05:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:05:49 INFO - 'MOZ_NO_REMOTE': '1', 23:05:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:05:49 INFO - 'NO_EM_RESTART': '1', 23:05:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:05:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:05:49 INFO - 'PWD': '/builds/slave/test-pgo', 23:05:49 INFO - 'SHELL': '/bin/bash', 23:05:49 INFO - 'SHLVL': '1', 23:05:49 INFO - 'TERM': 'linux', 23:05:49 INFO - 'TMOUT': '86400', 23:05:49 INFO - 'USER': 'cltbld', 23:05:49 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:05:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:05:49 INFO - '_': '/tools/buildbot/bin/python'} 23:05:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:05:49 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 23:05:49 INFO - Cleaning up... 23:05:49 INFO - Return code: 0 23:05:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 23:05:49 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')]} 23:05:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:05:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:49 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')]} 23:05:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:05:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:49 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:05:49 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 23:05:49 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 23:05:49 INFO - Using env: {'DISPLAY': ':0', 23:05:49 INFO - 'HOME': '/home/cltbld', 23:05:49 INFO - 'LANG': 'en_US.UTF-8', 23:05:49 INFO - 'LANGUAGE': 'en_US:en', 23:05:49 INFO - 'LOGNAME': 'cltbld', 23:05:49 INFO - 'MAIL': '/var/mail/cltbld', 23:05:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:05:49 INFO - 'MOZ_NO_REMOTE': '1', 23:05:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:05:49 INFO - 'NO_EM_RESTART': '1', 23:05:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:05:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:05:49 INFO - 'PWD': '/builds/slave/test-pgo', 23:05:49 INFO - 'SHELL': '/bin/bash', 23:05:49 INFO - 'SHLVL': '1', 23:05:49 INFO - 'TERM': 'linux', 23:05:49 INFO - 'TMOUT': '86400', 23:05:49 INFO - 'USER': 'cltbld', 23:05:49 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:05:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:05:49 INFO - '_': '/tools/buildbot/bin/python'} 23:05:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:05:50 INFO - Downloading/unpacking psutil>=0.7.1 23:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 23:05:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:05:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:05:51 INFO - Installing collected packages: psutil 23:05:51 INFO - Running setup.py install for psutil 23:05:52 INFO - building 'psutil._psutil_linux' extension 23:05:52 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 23:05:52 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 23:05:52 INFO - building 'psutil._psutil_posix' extension 23:05:52 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 23:05:52 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 23:05:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:05:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:05:52 INFO - Successfully installed psutil 23:05:52 INFO - Cleaning up... 23:05:52 INFO - Return code: 0 23:05:52 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 23:05:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:05:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:05:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:52 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:05:52 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 23:05:52 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 23:05:52 INFO - Using env: {'DISPLAY': ':0', 23:05:52 INFO - 'HOME': '/home/cltbld', 23:05:52 INFO - 'LANG': 'en_US.UTF-8', 23:05:52 INFO - 'LANGUAGE': 'en_US:en', 23:05:52 INFO - 'LOGNAME': 'cltbld', 23:05:52 INFO - 'MAIL': '/var/mail/cltbld', 23:05:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:05:52 INFO - 'MOZ_NO_REMOTE': '1', 23:05:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:05:52 INFO - 'NO_EM_RESTART': '1', 23:05:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:05:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:05:52 INFO - 'PWD': '/builds/slave/test-pgo', 23:05:52 INFO - 'SHELL': '/bin/bash', 23:05:52 INFO - 'SHLVL': '1', 23:05:52 INFO - 'TERM': 'linux', 23:05:52 INFO - 'TMOUT': '86400', 23:05:52 INFO - 'USER': 'cltbld', 23:05:52 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:05:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:05:52 INFO - '_': '/tools/buildbot/bin/python'} 23:05:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:05:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 23:05:52 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 23:05:52 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 23:05:52 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 23:05:52 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 23:05:52 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 23:05:52 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 23:05:54 INFO - Downloading mozsystemmonitor-0.0.tar.gz 23:05:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 23:05:54 INFO - Installing collected packages: mozsystemmonitor 23:05:54 INFO - Running setup.py install for mozsystemmonitor 23:05:54 INFO - Successfully installed mozsystemmonitor 23:05:54 INFO - Cleaning up... 23:05:54 INFO - Return code: 0 23:05:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 23:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:05:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:05:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:05:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 23:05:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:05:54 INFO - Using env: {'DISPLAY': ':0', 23:05:54 INFO - 'HOME': '/home/cltbld', 23:05:54 INFO - 'LANG': 'en_US.UTF-8', 23:05:54 INFO - 'LANGUAGE': 'en_US:en', 23:05:54 INFO - 'LOGNAME': 'cltbld', 23:05:54 INFO - 'MAIL': '/var/mail/cltbld', 23:05:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:05:54 INFO - 'MOZ_NO_REMOTE': '1', 23:05:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:05:54 INFO - 'NO_EM_RESTART': '1', 23:05:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:05:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:05:54 INFO - 'PWD': '/builds/slave/test-pgo', 23:05:54 INFO - 'SHELL': '/bin/bash', 23:05:54 INFO - 'SHLVL': '1', 23:05:54 INFO - 'TERM': 'linux', 23:05:54 INFO - 'TMOUT': '86400', 23:05:54 INFO - 'USER': 'cltbld', 23:05:54 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:05:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:05:54 INFO - '_': '/tools/buildbot/bin/python'} 23:05:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:05:55 INFO - Downloading/unpacking blobuploader==1.2.4 23:05:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:56 INFO - Downloading blobuploader-1.2.4.tar.gz 23:05:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:05:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:05:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 23:05:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:05:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:05:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:05:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:05:57 INFO - Downloading docopt-0.6.1.tar.gz 23:05:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 23:05:57 INFO - Installing collected packages: blobuploader, requests, docopt 23:05:57 INFO - Running setup.py install for blobuploader 23:05:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:05:57 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 23:05:57 INFO - Running setup.py install for requests 23:05:58 INFO - Running setup.py install for docopt 23:05:58 INFO - Successfully installed blobuploader requests docopt 23:05:58 INFO - Cleaning up... 23:05:58 INFO - Return code: 0 23:05:58 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:05:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:05:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:05:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:05:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:05:58 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:05:58 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 23:05:58 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 23:05:58 INFO - Using env: {'DISPLAY': ':0', 23:05:58 INFO - 'HOME': '/home/cltbld', 23:05:58 INFO - 'LANG': 'en_US.UTF-8', 23:05:58 INFO - 'LANGUAGE': 'en_US:en', 23:05:58 INFO - 'LOGNAME': 'cltbld', 23:05:58 INFO - 'MAIL': '/var/mail/cltbld', 23:05:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:05:58 INFO - 'MOZ_NO_REMOTE': '1', 23:05:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:05:58 INFO - 'NO_EM_RESTART': '1', 23:05:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:05:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:05:58 INFO - 'PWD': '/builds/slave/test-pgo', 23:05:58 INFO - 'SHELL': '/bin/bash', 23:05:58 INFO - 'SHLVL': '1', 23:05:58 INFO - 'TERM': 'linux', 23:05:58 INFO - 'TMOUT': '86400', 23:05:58 INFO - 'USER': 'cltbld', 23:05:58 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:05:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:05:58 INFO - '_': '/tools/buildbot/bin/python'} 23:05:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:05:58 INFO - Running setup.py (path:/tmp/pip-XDtjen-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:05:58 INFO - Running setup.py (path:/tmp/pip-DChEli-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:05:58 INFO - Running setup.py (path:/tmp/pip-yQzfGe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:05:58 INFO - Running setup.py (path:/tmp/pip-ELDa0d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:05:58 INFO - Running setup.py (path:/tmp/pip-KyX_UG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:05:58 INFO - Running setup.py (path:/tmp/pip-a5ye0k-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:05:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:05:58 INFO - Running setup.py (path:/tmp/pip-ar_Wu5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:05:59 INFO - Running setup.py (path:/tmp/pip-G3vKpb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:05:59 INFO - Running setup.py (path:/tmp/pip-IyihDV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:05:59 INFO - Running setup.py (path:/tmp/pip-sXjFHm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:05:59 INFO - Running setup.py (path:/tmp/pip-_YV6Vu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:05:59 INFO - Running setup.py (path:/tmp/pip-5qDS92-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:05:59 INFO - Running setup.py (path:/tmp/pip-LRxUbO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:05:59 INFO - Running setup.py (path:/tmp/pip-NwE0ZB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:05:59 INFO - Running setup.py (path:/tmp/pip-lNcG6c-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:05:59 INFO - Running setup.py (path:/tmp/pip-TDmVvc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:05:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:05:59 INFO - Running setup.py (path:/tmp/pip-PbOOgI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:05:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:05:59 INFO - Running setup.py install for manifestparser 23:05:59 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 23:05:59 INFO - Running setup.py install for mozcrash 23:05:59 INFO - Running setup.py install for mozdebug 23:06:00 INFO - Running setup.py install for mozdevice 23:06:00 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for mozfile 23:06:00 INFO - Running setup.py install for mozhttpd 23:06:00 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for mozinfo 23:06:00 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for mozInstall 23:06:00 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for mozleak 23:06:00 INFO - Running setup.py install for mozlog 23:06:00 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for moznetwork 23:06:00 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 23:06:00 INFO - Running setup.py install for mozprocess 23:06:00 INFO - Running setup.py install for mozprofile 23:06:01 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 23:06:01 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 23:06:01 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 23:06:01 INFO - Running setup.py install for mozrunner 23:06:01 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 23:06:01 INFO - Running setup.py install for mozscreenshot 23:06:01 INFO - Running setup.py install for moztest 23:06:01 INFO - Running setup.py install for mozversion 23:06:01 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 23:06:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:06:01 INFO - Cleaning up... 23:06:01 INFO - Return code: 0 23:06:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:06:01 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')]} 23:06:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:06:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:01 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')]} 23:06:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:06:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:01 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:06:01 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 23:06:01 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 23:06:01 INFO - Using env: {'DISPLAY': ':0', 23:06:01 INFO - 'HOME': '/home/cltbld', 23:06:01 INFO - 'LANG': 'en_US.UTF-8', 23:06:01 INFO - 'LANGUAGE': 'en_US:en', 23:06:01 INFO - 'LOGNAME': 'cltbld', 23:06:01 INFO - 'MAIL': '/var/mail/cltbld', 23:06:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:06:01 INFO - 'MOZ_NO_REMOTE': '1', 23:06:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:06:01 INFO - 'NO_EM_RESTART': '1', 23:06:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:06:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:06:01 INFO - 'PWD': '/builds/slave/test-pgo', 23:06:01 INFO - 'SHELL': '/bin/bash', 23:06:01 INFO - 'SHLVL': '1', 23:06:01 INFO - 'TERM': 'linux', 23:06:01 INFO - 'TMOUT': '86400', 23:06:01 INFO - 'USER': 'cltbld', 23:06:01 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:06:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:06:01 INFO - '_': '/tools/buildbot/bin/python'} 23:06:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:06:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:06:01 INFO - Running setup.py (path:/tmp/pip-fFoc8M-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:06:01 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)) 23:06:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:06:01 INFO - Running setup.py (path:/tmp/pip-T7Y2Xy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:06:01 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)) 23:06:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:06:01 INFO - Running setup.py (path:/tmp/pip-avgcsL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:06:01 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)) 23:06:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:06:01 INFO - Running setup.py (path:/tmp/pip-FEfWYH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:06:02 INFO - Running setup.py (path:/tmp/pip-0OGfgy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:06:02 INFO - Running setup.py (path:/tmp/pip-eUS7l7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:06:02 INFO - Running setup.py (path:/tmp/pip-nheYb3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:06:02 INFO - Running setup.py (path:/tmp/pip-g4mhCP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:06:02 INFO - Running setup.py (path:/tmp/pip-DNBu0g-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:06:02 INFO - Running setup.py (path:/tmp/pip-hHixaB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:06:02 INFO - Running setup.py (path:/tmp/pip-ozrqUl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:06:02 INFO - Running setup.py (path:/tmp/pip-Ik9HJB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:06:02 INFO - Running setup.py (path:/tmp/pip-x6Gswx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:06:02 INFO - Running setup.py (path:/tmp/pip-oPDyH2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:06:02 INFO - Running setup.py (path:/tmp/pip-Am8Xne-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:06:02 INFO - Running setup.py (path:/tmp/pip-Pc4swH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:06:02 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)) 23:06:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:06:02 INFO - Running setup.py (path:/tmp/pip-L4cwh9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:06:02 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)) 23:06:02 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)) 23:06:02 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)) 23:06:02 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)) 23:06:02 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)) 23:06:02 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)) 23:06:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 23:06:02 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 23:06:02 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 23:06:02 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 23:06:02 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 23:06:02 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 23:06:02 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 23:06:04 INFO - Downloading blessings-1.6.tar.gz 23:06:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 23:06:04 INFO - Installing collected packages: blessings 23:06:04 INFO - Running setup.py install for blessings 23:06:04 INFO - Successfully installed blessings 23:06:04 INFO - Cleaning up... 23:06:05 INFO - Return code: 0 23:06:05 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 23:06:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:06:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:06:05 INFO - Reading from file tmpfile_stdout 23:06:05 INFO - Current package versions: 23:06:05 INFO - argparse == 1.2.1 23:06:05 INFO - blessings == 1.6 23:06:05 INFO - blobuploader == 1.2.4 23:06:05 INFO - docopt == 0.6.1 23:06:05 INFO - manifestparser == 1.1 23:06:05 INFO - mozInstall == 1.12 23:06:05 INFO - mozcrash == 0.16 23:06:05 INFO - mozdebug == 0.1 23:06:05 INFO - mozdevice == 0.48 23:06:05 INFO - mozfile == 1.2 23:06:05 INFO - mozhttpd == 0.7 23:06:05 INFO - mozinfo == 0.9 23:06:05 INFO - mozleak == 0.1 23:06:05 INFO - mozlog == 3.1 23:06:05 INFO - moznetwork == 0.27 23:06:05 INFO - mozprocess == 0.22 23:06:05 INFO - mozprofile == 0.28 23:06:05 INFO - mozrunner == 6.11 23:06:05 INFO - mozscreenshot == 0.1 23:06:05 INFO - mozsystemmonitor == 0.0 23:06:05 INFO - moztest == 0.7 23:06:05 INFO - mozversion == 1.4 23:06:05 INFO - psutil == 3.1.1 23:06:05 INFO - requests == 1.2.3 23:06:05 INFO - wsgiref == 0.1.2 23:06:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:06:05 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')]} 23:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:06:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:05 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')]} 23:06:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:06:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:05 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:06:05 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 23:06:05 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 23:06:05 INFO - Using env: {'DISPLAY': ':0', 23:06:05 INFO - 'HOME': '/home/cltbld', 23:06:05 INFO - 'LANG': 'en_US.UTF-8', 23:06:05 INFO - 'LANGUAGE': 'en_US:en', 23:06:05 INFO - 'LOGNAME': 'cltbld', 23:06:05 INFO - 'MAIL': '/var/mail/cltbld', 23:06:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:06:05 INFO - 'MOZ_NO_REMOTE': '1', 23:06:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:06:05 INFO - 'NO_EM_RESTART': '1', 23:06:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:06:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:06:05 INFO - 'PWD': '/builds/slave/test-pgo', 23:06:05 INFO - 'SHELL': '/bin/bash', 23:06:05 INFO - 'SHLVL': '1', 23:06:05 INFO - 'TERM': 'linux', 23:06:05 INFO - 'TMOUT': '86400', 23:06:05 INFO - 'USER': 'cltbld', 23:06:05 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:06:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:06:05 INFO - '_': '/tools/buildbot/bin/python'} 23:06:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 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)) 23:06:05 INFO - Cleaning up... 23:06:05 INFO - Return code: 0 23:06:05 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 23:06:05 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')]} 23:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:06:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:05 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')]} 23:06:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:06:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:05 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:06:05 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 23:06:05 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 23:06:05 INFO - Using env: {'DISPLAY': ':0', 23:06:05 INFO - 'HOME': '/home/cltbld', 23:06:05 INFO - 'LANG': 'en_US.UTF-8', 23:06:05 INFO - 'LANGUAGE': 'en_US:en', 23:06:05 INFO - 'LOGNAME': 'cltbld', 23:06:05 INFO - 'MAIL': '/var/mail/cltbld', 23:06:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:06:05 INFO - 'MOZ_NO_REMOTE': '1', 23:06:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:06:05 INFO - 'NO_EM_RESTART': '1', 23:06:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:06:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:06:05 INFO - 'PWD': '/builds/slave/test-pgo', 23:06:05 INFO - 'SHELL': '/bin/bash', 23:06:05 INFO - 'SHLVL': '1', 23:06:05 INFO - 'TERM': 'linux', 23:06:05 INFO - 'TMOUT': '86400', 23:06:05 INFO - 'USER': 'cltbld', 23:06:05 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:06:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:06:05 INFO - '_': '/tools/buildbot/bin/python'} 23:06:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:06:05 INFO - Downloading/unpacking jsonschema 23:06:05 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 23:06:05 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 23:06:05 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 23:06:05 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 23:06:05 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 23:06:05 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 23:06:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:06:07 INFO - Downloading/unpacking functools32 (from jsonschema) 23:06:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:07 INFO - Downloading functools32-3.2.3-2.tar.gz 23:06:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 23:06:07 INFO - warning: no files found matching '*.txt' 23:06:07 INFO - no previously-included directories found matching 'build' 23:06:07 INFO - no previously-included directories found matching 'dist' 23:06:07 INFO - no previously-included directories found matching '.git*' 23:06:07 INFO - Installing collected packages: jsonschema, functools32 23:06:07 INFO - Running setup.py install for functools32 23:06:07 INFO - warning: no files found matching '*.txt' 23:06:07 INFO - no previously-included directories found matching 'build' 23:06:07 INFO - no previously-included directories found matching 'dist' 23:06:07 INFO - no previously-included directories found matching '.git*' 23:06:07 INFO - Successfully installed jsonschema functools32 23:06:07 INFO - Cleaning up... 23:06:08 INFO - Return code: 0 23:06:08 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 23:06:08 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')]} 23:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:06:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:08 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')]} 23:06:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:06:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:06:08 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 0x7fb93ba9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10bc670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, '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': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', '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 23:06:08 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 23:06:08 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 23:06:08 INFO - Using env: {'DISPLAY': ':0', 23:06:08 INFO - 'HOME': '/home/cltbld', 23:06:08 INFO - 'LANG': 'en_US.UTF-8', 23:06:08 INFO - 'LANGUAGE': 'en_US:en', 23:06:08 INFO - 'LOGNAME': 'cltbld', 23:06:08 INFO - 'MAIL': '/var/mail/cltbld', 23:06:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:06:08 INFO - 'MOZ_NO_REMOTE': '1', 23:06:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:06:08 INFO - 'NO_EM_RESTART': '1', 23:06:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:06:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:06:08 INFO - 'PWD': '/builds/slave/test-pgo', 23:06:08 INFO - 'SHELL': '/bin/bash', 23:06:08 INFO - 'SHLVL': '1', 23:06:08 INFO - 'TERM': 'linux', 23:06:08 INFO - 'TMOUT': '86400', 23:06:08 INFO - 'USER': 'cltbld', 23:06:08 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:06:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:06:08 INFO - '_': '/tools/buildbot/bin/python'} 23:06:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:06:08 INFO - Downloading/unpacking flake8 23:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:06:10 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:06:10 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:06:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:06:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 23:06:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:06:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:06:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:06:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:06:10 INFO - no previously-included directories found matching 'docs/_build' 23:06:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:06:10 INFO - Running setup.py install for pep8 23:06:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:06:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:06:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:06:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:06:10 INFO - no previously-included directories found matching 'docs/_build' 23:06:10 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 23:06:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:06:10 INFO - Cleaning up... 23:06:10 INFO - Return code: 0 23:06:10 INFO - Running post-action listener: _resource_record_post_action 23:06:10 INFO - Running post-action listener: _start_resource_monitoring 23:06:10 INFO - Starting resource monitoring. 23:06:10 INFO - ##### 23:06:10 INFO - ##### Running install step. 23:06:10 INFO - ##### 23:06:10 INFO - Running pre-action listener: _resource_record_pre_action 23:06:10 INFO - Running main action method: install 23:06:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:06:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:06:11 INFO - Reading from file tmpfile_stdout 23:06:11 INFO - Detecting whether we're running mozinstall >=1.0... 23:06:11 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 23:06:11 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 23:06:11 INFO - Reading from file tmpfile_stdout 23:06:11 INFO - Output received: 23:06:11 INFO - Usage: mozinstall [options] installer 23:06:11 INFO - Options: 23:06:11 INFO - -h, --help show this help message and exit 23:06:11 INFO - -d DEST, --destination=DEST 23:06:11 INFO - Directory to install application into. [default: 23:06:11 INFO - "/builds/slave/test-pgo"] 23:06:11 INFO - --app=APP Application being installed. [default: firefox] 23:06:11 INFO - mkdir: /builds/slave/test-pgo/build/application 23:06:11 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 23:06:11 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 23:06:27 INFO - Reading from file tmpfile_stdout 23:06:27 INFO - Output received: 23:06:27 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 23:06:27 INFO - Running post-action listener: _resource_record_post_action 23:06:27 INFO - ##### 23:06:27 INFO - ##### Running run-tests step. 23:06:27 INFO - ##### 23:06:27 INFO - Running pre-action listener: _resource_record_pre_action 23:06:27 INFO - Running main action method: run_tests 23:06:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 23:06:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 23:06:27 INFO - Python 2.7.3 23:06:27 INFO - Return code: 0 23:06:27 INFO - grabbing minidump binary from tooltool 23:06: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')]} 23:06:27 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 0x114b8c0>, '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 0x114c7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x114cc50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 23:06:27 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 23:06:27 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 23:06:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:06:27 INFO - Return code: 0 23:06:27 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 23:06:27 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 23:06:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 23:06:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 23:06:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 23:06:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 23:06:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 23:06:28 INFO - Return code: 0 23:06:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 23:06:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-048 --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 23:06:28 INFO - Using env: {'DISPLAY': ':0', 23:06:28 INFO - 'HOME': '/home/cltbld', 23:06:28 INFO - 'LANG': 'en_US.UTF-8', 23:06:28 INFO - 'LANGUAGE': 'en_US:en', 23:06:28 INFO - 'LOGNAME': 'cltbld', 23:06:28 INFO - 'MAIL': '/var/mail/cltbld', 23:06:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:06:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 23:06:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:06:28 INFO - 'MOZ_NO_REMOTE': '1', 23:06:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:06:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:06:28 INFO - 'NO_EM_RESTART': '1', 23:06:28 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:06:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:06:28 INFO - 'PWD': '/builds/slave/test-pgo', 23:06:28 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 23:06:28 INFO - 'SHELL': '/bin/bash', 23:06:28 INFO - 'SHLVL': '1', 23:06:28 INFO - 'TERM': 'linux', 23:06:28 INFO - 'TMOUT': '86400', 23:06:28 INFO - 'USER': 'cltbld', 23:06:28 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066', 23:06:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:06:28 INFO - '_': '/tools/buildbot/bin/python'} 23:06:28 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 23:06:28 INFO - mozversion application_buildid: 20160215203228 23:06:28 INFO - mozversion application_changeset: fb7ceaf4b009243423cdaf1077adbb6c609b22e5 23:06:28 INFO - mozversion application_display_name: Nightly 23:06:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:06:28 INFO - mozversion application_name: Firefox 23:06:28 INFO - mozversion application_remotingname: firefox 23:06:28 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 23:06:28 INFO - mozversion application_vendor: Mozilla 23:06:28 INFO - mozversion application_version: 47.0a1 23:06:28 INFO - mozversion platform_buildid: 20160215203228 23:06:28 INFO - mozversion platform_changeset: fb7ceaf4b009243423cdaf1077adbb6c609b22e5 23:06:28 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 23:06:28 INFO - mozversion platform_version: 47.0a1 23:06:28 INFO - using testdate: 1455606388 23:06:28 INFO - actual date: 1455606388 23:06:28 INFO - starting webserver on 'localhost:46753' 23:06:28 INFO - SUITE-START | Running 2 tests 23:06:28 INFO - TEST-START | dromaeo_css 23:06:28 INFO - operating with platform_type : linux_ 23:06:28 INFO - Initialising browser for dromaeo_css test... 23:06:28 INFO - TEST-INFO | started process 28519 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_79QDc/profile http://localhost:46753/getInfo.html) 23:06:33 INFO - PROCESS | 28519 | __metrics Screen width/height:1600/1200 23:06:33 INFO - PROCESS | 28519 | colorDepth:24 23:06:33 INFO - PROCESS | 28519 | Browser inner width/height: 1024/697 23:06:33 INFO - PROCESS | 28519 | __metrics 23:06:34 INFO - PROCESS | 28519 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:06:35 INFO - TEST-INFO | 28519: exit 0 23:06:35 INFO - Browser initialized. 23:06:35 INFO - Running cycle 1/1 for dromaeo_css test... 23:06:35 INFO - TEST-INFO | started process 28616 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_79QDc/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:06:47 INFO - PROCESS | 28616 | RSS: Main: 149921792 23:06:47 INFO - PROCESS | 28616 | 23:07:38 INFO - PROCESS | 28616 | 1455606458601 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] 23:09:46 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46753/tests/dromaeo/cssquery-ext.html) 23:09:47 INFO - PROCESS | 28616 | RSS: Main: 263708672 23:09:47 INFO - PROCESS | 28616 | 23:12:50 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-ext.html (next: http://localhost:46753/tests/dromaeo/cssquery-jquery.html) 23:12:50 INFO - PROCESS | 28616 | RSS: Main: 244695040 23:12:50 INFO - PROCESS | 28616 | 23:15:53 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46753/tests/dromaeo/cssquery-mootools.html) 23:15:53 INFO - PROCESS | 28616 | RSS: Main: 243179520 23:15:53 INFO - PROCESS | 28616 | 23:18:55 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46753/tests/dromaeo/cssquery-prototype.html) 23:18:56 INFO - PROCESS | 28616 | RSS: Main: 219303936 23:18:56 INFO - PROCESS | 28616 | 23:21:58 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46753/tests/dromaeo/cssquery-yui.html) 23:21:59 INFO - PROCESS | 28616 | RSS: Main: 220299264 23:21:59 INFO - PROCESS | 28616 | 23:25:01 INFO - PROCESS | 28616 | Cycle 1(1): loaded http://localhost:46753/tests/dromaeo/cssquery-yui.html (next: http://localhost:46753/tests/dromaeo/cssquery-dojo.html) 23:25:02 INFO - PROCESS | 28616 | RSS: Main: 290521088 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | __start_tp_report 23:25:02 INFO - PROCESS | 28616 | _x_x_mozilla_page_load 23:25:02 INFO - PROCESS | 28616 | _x_x_mozilla_page_load_details 23:25:02 INFO - PROCESS | 28616 | |i|pagename|runs| 23:25:02 INFO - PROCESS | 28616 | |0;dojo.html;3082.0445661844824;3096.1640357103597;3139.4035133324664;3143.135637699631;3199.2801619635584;4920.237363208699;5043.420006699231;5060.114479966005;5112;5126.718030508325;5019.824306149286;5022.347094877661;5032.6477146599755;5040.445550989388;5065.544101030907;4641.9071618567605;4668.369770081038;4736.81052757891;4763.38076050113;4769.642276829234;4577.290519969393;4593.219152744042;4723.36234608327;4737.952620473786;4852.951470485285;4685.718856868599;4690.108879312919;4701.623870090384;4720.527947205286;4756.167670657621;4688.156131896258;4703.905921881577;4716.268978308368;4721.952780472186;4745.525447455261;4594.264917613199;4640.976795116003;4676.812927482896;4686.484486706459;4702.988857395642;4986.975065124688;5000.349954505891;5024.773885175176;5033.622478314104;5057.241413787924;5362.973185134049;5487.64330318528;5491.505764481216;5500.28496295483;5509.917351239735;5368.463153684639;5405.864853378697;5446.482584154499;5457.045017121988;5495.6153069285165;5136.74316284188;5140.640155189101;5140.897182056338;5149.639525233272;5155.046316431435;5400.405955344909;5496.065668836308;5585.273914391184;5586.24585680936;5605.635633683797;5391.514763671288;5412.539934105645;5439.401665816757;5440.564754819605;5492.47821456961;5393.110136827458;5411.540019098342;5411.567074634098;5412.648177868505;5416.660454900096;5361.249425080492;5368.865778355573;5382.91925621116;5426.321709786277;5449.618526703092;5449.3460784706085;5455.918161227585;5467.890642187213;5474.09677403224;5492.231087647732;4283.807228674717;4287.807048682755;4298.484181898192;4329.523752387235;4336.132773445323;3782.6028267032116;3794.487744154559;3815.465834783133;3833.8083095845095;3847.9038024049623;5058.924116138261;5083.542481176712;5083.949160508348;5085.593152547787;5120.129577971754;5358.4373640767935;5409.999150157233;5410.567154627621;5418.051840927822;5447.400785913546;5013.222950442687;5062.924056139161;5071.822486212965;5116.590672746172;5140.460251673595;4655.86032419028;4657.347971284023;4663.230566956482;4680.251159814414;4707.176244157259;5507.889842203133;5610.1304297833085;5611.803586874522;5625.071863142535;5625.296837895263;5335.226392173191;5444.265024221838;5486.451354864482;5499.835004949858;5506.339239291311;5588;5601.243832082617;5602.579806514609;5602.887942241214;5604.8318550443555;5266.078436273713;5348.866278343073;5354.063038968243;5354.384245811626;5399.973000134974;5550.111982083009;5556.527695145796;5570.4151064139305;5600.803971860965;5613.242212301287;5367.248585197997;5387.0572649785345;5397.730113494388;5405.648632838853;5411.080116380146;5297.125974214211;5362.088444964287;5425.891482170414;5430.456954304538;5449.64577302474;5292.52367286946;5348.839534813962;5367.409584945731;5382.67703937765;5400.83797486076;5300.1254792958725;5328.786848526015;5342.225377320345;5354.089804733127;5379.462053794589;5220.321358223407;5235.1623740201385;5257.894842103213;5258.50044245796;5271.051210782096 23:25:02 INFO - PROCESS | 28616 | |1;ext.html;519.7479222577052;536.0244355273403;547.0208327094501;559.0356634804962;574.7298769578299;28750.13749587513;36227.456588151166;37052;37119.25761484769;37120.47355501223;40723.389149162715;41076.58923410765;41166.794166029205;41177.382339264936;41331.58668413315;8519.488830670163;8722;8727.0836562161;8733.650653973833;8742.825143497126;8552.743417697478;8655.350848686343;8700.303975681962;8706.782330441727;8952.686655967042;8886.20024197822;8985.146411090936;8996.68511602094;8997.505137217451;9007.189352958232;8874.778130546723;8965.506897120657;8966.551672416419;8968.327375446803;8979.057198994076;8771.736847894574;8915.063918288615;8915.108489151098;8928.330375221884;8928.37501374904;39437.21125577501;39909.60090399088;39981;39984.20031599381;40001.399979000045;3096.1949893027977;3192.8563214655396;3213.1645772099423;3266.1508007917873;3719.3491139050557;28053.810045141716;28211.435771284665;28652.570211446844;28657.28356791097;28663.28341791451;3858.961410385916;3941.9211615767813;3949.605039496056;3973.4834471518807;3976.642102210786;274283;280670;281144.99999999796;281178;281361;61513.69243153756;65022.34977650163;65489.67255163693;65875;66031.66984165048;59924.400755992756;67970;68420.31579684239;68618.65690671514;68698.65650671815;15952.92023539875;16322.591935201477;16394.508164755076;16461.58846028835;16468.176591170395;10078.748031299276;11362;11532.077433805276;12176.634700958986;12370.257784532956;20605;20909.581808363746;20963.685544716842;21153;21177.258795942067;8392.664293428195;8570.400071995025;8639.524826134497;8866.20204181614;8926.464412135163;917.5412293853074;922.1285884838763;973.1825266775942;989.44096585429;1068.3048004022278;28694.713052869203;28983.275418114717;29079.854600727285;29081.854590727333;29363.85318073396;1014.1481155828991;1032.488917985602;1042.3693665332517;1076.6608518316705;1120.1990576737671;15280.770788438182;15364.308606112752;15519;16371.42700005494;16641.251143698322;378400;381455;383467;384787;384825;54835.17747233795;55151.724241379336;55239.72380138074;55277.447225528034;55317.723411382685;1403.7262733766818;1404.7331007108617;1433.2117335465243;1433.4767809749576;1442.9711405772036;29798.70201298046;30565.54151687771;30654.77380904828;30978.69021309848;31304.686953130178;46111.53888461207;46564.7671761639;46786.29820552626;46867.531324686315;46906;300902;301697;302101;302192;303254;27795.861020694767;31168.376632467676;31477.213069673442;31766.841165794023;31784.523232151998;36613.450798238584;37667.623323767504;37805.43291850569;37980;38283.80858095692;32507.34985300328;34496.82751586326;34667;34726.30547388987;35292.64707352893;27806.44387112287;33730.831345843115;34741;34791.13022174466;35911;34542.33678453376;34656.82671586626;35407.29185416329;35778.10554736153;35782.46326305055;29708.257293567833;31129.221769455038;31484.370312594077;31583.684163158076;31652.208694782814;24369.756302437458;24410.633840492053;24435.511289774462;24793;24846 23:25:02 INFO - PROCESS | 28616 | |2;jquery.html;355.9092431429985;356.3194298889122;359.8236863936671;363.3314700950251;366.09026568976105;15960;16319.918400407996;17042;17123.914380428098;17205.13974301283;16780.496585102468;17041.147942602853;17116.229769660364;17220.13899305036;17548.12259387032;5233.685978841263;5240.397354304266;5334.759935802879;5405.594580406466;5409.702466364349;5319.840404787863;5365.087935051031;5374.113271310249;5379.058664733676;5381.569474442055;3957.861474848381;4097.754134751909;5146.433892271847;5298.682079075268;5648.661080335172;5535.335759708861;5789.971050144764;5817.41825817417;5823.854403639901;5824.767009319643;5105.846824595268;5127.230915362688;5133.204353325241;5133.640645154841;5134.17853143499;15662.765058524132;18286.725699114522;18956.5260868478;19063.904680476648;19284.710729339073;2015.5602848897777;2190.9561808763738;2269.6028195065965;2504.248725382378;2607.374230184761;11864.169508134433;12068.275903445734;12189.451474683661;12581.308028058453;12745.661705520879;1743.0935913325;1847.7875044369935;1870.4201697473827;1885.3589779475044;1982.4350060232764;58370;59633;60528.69735651294;62136.68931655313;62355;9412.388194767318;9574.617015319309;9847.606095756233;9865.260105492116;9878.110970012733;12760.29818359999;12770;12796.680082997813;12810;12845.421956012002;7411.962940185264;7455.888161677579;7671.808204794925;7736.381089512825;7748.651310691032;7344.522606030698;7349.191588925214;7529.284717951896;7611.657475413509;7655.655495502716;5921.970390148022;5934.970325148433;5943.821685349447;5968.761249550056;5986.760529578855;1719.5701074731317;1776.6979613465742;1777.3564193403472;1778.6531626332742;1828.4240464253717;749.9587522686305;808.0626473290954;809.402207189039;845.2646197807946;886.3529623374843;14248.572542823731;15997;16376.83623163777;16395;18016;953;985.7929834734642;997.6930221409976;1014.4927536231884;1053.8261186904228;8066.596670166468;9375.390599611004;9519.333646644669;9540.712003879526;10045.748856278651;557340;568653.037552566;570540;571368;582193;66914.33085669081;68616.65691671609;68955.31044689589;77972.61013694895;79753.60123199347;1146.2377518949972;1149.373591392693;1154.872963973979;1194.5639841457978;1197.802362610177;14559.708805823613;14730.705385892008;14915.254237288309;15114.168720720467;15176.165310908005;32680.83659581687;33113.17217069593;34279.31441371109;34806.65193348034;35057.47413788744;47513.52486475091;47522;49051.75474122607;49638;49960;7566.092068951541;7811.804704882424;7842.451028427955;7945.205479452008;7947.642356093874;10112.59549618007;11759.353235572125;11996.100292477924;12199.57301494479;12358.691032723895;9749.220062395134;10003.949980250052;10457.895421045996;10518.526666299882;10687.732806679895;10073.143782778547;10128.949355253177;10408.791824163625;10532.842007370049;10537.315074520131;10559.788804224027;10713.14294856394;10908.836367454653;11068.28056176346;11204.495797689287;5811.535077193899;6713.731450741916;7652.885206721792;7740.187280335484;8090.6359213836695;10221.846672300071;10241;10462.215333850145;10556.736081597714;10749.086327661924 23:25:02 INFO - PROCESS | 28616 | |3;mootools.html;1330.9334533273334;1448.4278709909584;1458.934347954342;1618.4254589620684;1787.0796539782007;6853.417459515941;7270.781876543706;7360.411167106632;7405.111386633612;7434.070741157356;7522.059742532184;7729.149793522722;7733.265339792725;7746.96126519368;7750;1996.680531115022;2035.328341647253;2039.51051747581;2260.457490202356;2295.701558797354;2289.8855057247156;2323.2101085630884;2331.3705299569106;2337;2343.894524746382;2270.648049552322;2279.9316020519327;2297.5519773644146;2326.3253656439697;2328.39461739948;2234.318532847481;2245.62947113726;2252.0653928619686;2254.5152792149684;2312.5259321838985;2269.0810221860174;2273.227102785061;2275.795178433949;2288.8626682398944;2290.244219407608;7846.136924938252;7893.250141236574;7909.327707144899;7909.7231596893835;7914.881276780853;4633.4671512775785;4695.647826413033;4721.645876559238;4740.312654665055;4742.359781429497;3093.9381212375624;3114.205877501223;3175.333180032196;3180.8250546219947;3192.3136525646864;1020.3265844542566;1033.2147567848415;1069.9572017119306;1081.9505080072395;1107.916906232036;10785.083267922237;10793.622223222228;10795.946020269848;10815.621453249098;10815.729606759814;4299.613034826881;4320.611144996902;4376.037271800199;4398.934015989763;4407.118576284756;9227.90772092284;9239.584218710173;9265.490398028038;9267.629294828266;9274.90725092754;4831.275308703653;4834.419869615669;4838.806447742051;4840.6127509799835;4847.151748444008;4342;4380.3210502372185;4386.363977223285;4388.2759344707765;4397.846075387346;3361.966380336214;3547.396942519778;3635.0548857297294;3659.451082337671;3759.2293579816073;1162.5117450670568;1170.3680012792997;1172.1736175995902;1174.2954227463624;1177.6584790410857;1026.1841835740604;1047.8847326794046;1048.3028785857473;1166.2535976974573;1305.3929922586044;7231.2768723127265;7245.38414234796;7263.527870688388;7286.526375785557;7325.450591205681;1102.9558817647364;1105.7677887643524;1110.189561620022;1125.0661950580998;1131.8641762988493;5700.116481945305;5857.912131318034;5860.208871802337;5864;5869.325027621793;9438.764030899145;9452.385594936308;9527.333086684004;9684.70945871625;9718.514074296258;9455.385399948982;9515.33392662507;9581.808363832824;9596.66411675588;9609.327347085637;7267.563946163247;7478.551286922802;7516.774496765106;7536.321731044122;7539.886901696479;7178.318059784312;7201.3158749918675;7234.240404757636;7238.565686058853;7239;8294.792630184294;8432.32541396699;8473.364497662824;8490.617922193393;8583.098774628574;8680.479171249493;8724.56377181151;8743.825123497367;8925.821483570162;8943.23982461498;6996.650167491707;7058.082449281561;7063.081799366049;7066.081409416743;7070.540414873017;6337.429631333202;7040.929590704232;7260.927390726025;7263.309985551364;7579.583122928292;6987.1266091738535;7080.256573059961;7114.893276600958;7169.390601798906;7192.676329565077;6866.34769696878;6875.346842049998;6911.516193866381;7017.122859642544;7036.788896333118;7086.822829429099;7120;7128.180259270251;7129.4652901031595;7132.786016419515;6273.52948528853;6390.712417941111;6416.2300523935555;6437.871242575216;6549.083128362128;6493.707783149864;6519.8044058678315;6521.902171467337;6536;6549.214094308713 23:25:02 INFO - PROCESS | 28616 | |4;prototype.html;336.32063232270815;340.20222578054467;340.6814628322517;342.3256185314932;348.8674303764571;5702.600817942745;5782.248307719996;5818.8254352369395;5865.912011319829;5914.2902851657755;5682.545396368291;5806.7096645167785;5820.126980952859;5828.417158284169;5838.357780644125;4564.5435456454425;4574.862754117382;4578.198815207325;4579.152856721501;4587.518310577375;4347.804348804311;4438.755868427235;4483.753393563353;4512.142692888341;4565.429321334833;4406.801693923765;4473.686841921067;4486.753228572427;4494.955050449486;4499.3475945987975;4469.642428605704;4478.35063915732;4531.728096314232;4537.727736335831;4546.613537849286;4028.7179897407195;4034.7377420467574;4035.778032208227;4037.212743515016;4040.919181616351;5481.561475081984;5580.218769372291;5595.7481913313595;5648.265725455664;5650.5479561634975;5195.844124676266;5196.324477817897;5200.713960732158;5201.739913004372;5207.375114986188;5875.6474611523445;6255.40573645503;6266.624002559861;6270.592411493284;6274.2784579773;4294.098239369736;4377.6935614507;4406.779661016936;4420.469543654782;4421.557844215585;6373.776917807901;6414.069959855795;6471.676416179219;6476.384743449365;6500.024996250553;4536.070105628338;4550.590446859732;4550.817967281338;4553.02110046335;4553.362529245908;4512.849223448;4621.376114224604;4621.468531118897;4621.93067103987;4640.767961601974;5211.921821172686;5257.553107985864;5259.421463638997;5266.683998960075;5270.894582108336;6200.503959683215;6236.719347629368;6247.375262473716;6253.593516421418;6257.530685198628;1596.640755829929;1621.9189040547926;1624.16355576878;1624.3908534299637;1629.3156874112901;1110.7112150840678;1119.9664010079712;1122.1695945000804;1122.3770807202081;1151.1366475143643;5944.0786678064105;5954.672493012926;5969.970150149222;6022.337542870281;6024.427679370453;6418.614883106935;6425.068365087036;6437.388448097423;6447.065175549519;6449.838754031093;5851.882962340729;5945.048792193228;5945.16767652529;5952.523798096142;5974.103884417372;3429.6570342965506;3483.9477407838904;3487.4071407860724;3488.145404375944;3494.2138018945534;6631.767888123893;6683.997400389981;6694.430973367318;6697.8995315070315;6701.430378417889;6534.444572211415;6543.247526534509;6548.377904099103;6551.115599394021;6560.048792924999;6482.319356467598;6677.732890684415;6681.766138185238;6688.063671086052;6698.966505167443;6232.439080482778;6377.266614339411;6398.360163983564;6414.294427613052;6474.028895665688;6281.748730050929;6386.744530218925;6387.105805187184;6387.137736405526;6396.584222025554;6743.5953842769595;6749.088873002278;6758.8648227036165;6762.459003279824;6767.661616919233;4447.155040542287;4470.1059788041875;4570.154521413549;4600.930986035279;4603.884902877455;6492.64290464029;6502.252240992158;6504.772332968323;6506.642134682448;6515.348465153446;6319.273283572448;6325.430711236011;6326.652034137983;6334.113224148531;6335.366463353628;6156.5998210116195;6315.147455093687;6317.747290108344;6318.715657795318;6320.841978950379;6165.784197553064;6180.598261113013;6201.751929922752;6202.2867370253;6219.595726277777;6333.145025421509;6337.683115844282;6343.841403964938;6346.07981842621;6346.428821406095;5987.982043052779;6195.721192546256;6198.81403557894;6204;6210.937890621036 23:25:02 INFO - PROCESS | 28616 | |5;yui.html;682.7269092363055;741.5365396627108;772.1082150116614;792.4452882981914;797.2864286463619;13439.529616463426;13799.172049677001;13801.861981380183;13803.37884795184;13811.792823107662;12988.93505532471;13055.543055993043;13056.477740890377;13061.93469032656;13063.804042939364;662.374056516592;669.0232260899094;796.6972550430828;797.7566842113154;813.4427916876929;805.6857825448051;807.8868958345836;811.2131232704268;812.3907069697726;814.3810703865075;697.909271794666;839.6221700234888;846.7205822078699;847.1189962439056;848.4273115646945;699.7550857199965;699.8390370214854;700.8072779985494;832.7335252719132;850.8808766772656;630.3822254190873;630.4074170279922;630.5680608782999;630.9432151106422;631.4979591224987;12961.351932403342;13022.153560018569;13025.86974130256;13042.543510977164;13057.21656700601;12335.136540442172;12487.562935297312;12696.111272210948;12975.67560810978;13066.934665326613;9428.952855235748;9663.903360966371;9775.31572789905;9939.055789699967;10260.640877569249;3583.802890841003;3620.4207326827845;3660.7071434285194;3747.1756213632957;3755.0987762936697;46104.76947615274;47222.527774722155;47919.52080479186;48147;48334;9858.507074646239;10056.69829905104;10077.798444031077;10098.990100989842;10119.645812396531;17285.222165002353;17287.13564321779;17302.740458893128;17316.913415432842;17351.39270125565;7453.478256522099;7478.326950574475;7484.625768711543;7526.397888168934;7634.847303054019;4113.280175969194;4132.628063474302;4165.875023749292;4180.372944058355;4295.892602684896;3205.4390481665614;3221.8711251550144;3229.111994201566;3239.4654881944684;3247.9837600811843;584.4272612839441;598.8832177725388;604.3171216525299;642.6369101457661;662.2979641579844;675.1088563096763;678.5182520410465;684.4524380495584;689.9103116594811;703.6552089476222;7701.345385642283;8276.793080173044;8348.081711011784;8352.8329433411;8420.747377578682;515.3686733751125;526.4551189518829;548.363897878459;562.9894339660319;573.2604939627917;3534.840932158059;3757.342465068602;3940.7438516496336;3948.1314110895555;4041.797910104483;46949.29576056362;48344.75827620839;48622.27066594004;48865.26702099471;49044.75477622589;43797;44026.11947761091;44672;44817.32774008392;49694.25458618124;43970.560294397284;44253;44274.33588496175;44343.11313773706;44436;7855.8501223126395;7932;8145.185481451807;8171.428000040178;8270.2556769891;32616.836915816217;32794.34411311808;33246.50130248097;33492;34199;39745.60254397535;40232;40602.59397406106;40869.1826163481;42547.787261063495;10672.89327106719;11080.501377437873;11278.943605281922;11279;11356.94321528387;11512.589083130915;11563.710907227387;11729.296242225493;11803.704907377385;12042.578509752117;10332.328398654063;10945.343279403261;11078.279911805706;11300.773984520429;11411.087113030771;10958.506867190836;11166;11368;11406.600768973378;11665.708357291136;10865.022148006718;11012.284201526874;11013.83479247828;11029.172812038969;11496.48265828023;8481.915180848113;8691.565421728761;8765.912340876765;9016.143466370684;9361.485118318558;7921.841563168819;8204.712835050745;8401.95799021001;8615.22462978335;8899 23:25:02 INFO - PROCESS | 28616 | __end_tp_report 23:25:02 INFO - PROCESS | 28616 | __start_cc_report 23:25:02 INFO - PROCESS | 28616 | _x_x_mozilla_cycle_collect,884 23:25:02 INFO - PROCESS | 28616 | __end_cc_report 23:25:02 INFO - PROCESS | 28616 | __startTimestamp1455607502102__endTimestamp 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | ------- Summary: start ------- 23:25:02 INFO - PROCESS | 28616 | Number of tests: 6 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#0] dojo.html Cycles:165 Average:5082.25 Median:5297.13 stddev:535.17 (10.1%) stddev-sans-first:513.29 23:25:02 INFO - PROCESS | 28616 | Values: 3082.0 3096.2 3139.4 3143.1 3199.3 4920.2 5043.4 5060.1 5112.0 5126.7 5019.8 5022.3 5032.6 5040.4 5065.5 4641.9 4668.4 4736.8 4763.4 4769.6 4577.3 4593.2 4723.4 4738.0 4853.0 4685.7 4690.1 4701.6 4720.5 4756.2 4688.2 4703.9 4716.3 4722.0 4745.5 4594.3 4641.0 4676.8 4686.5 4703.0 4987.0 5000.3 5024.8 5033.6 5057.2 5363.0 5487.6 5491.5 5500.3 5509.9 5368.5 5405.9 5446.5 5457.0 5495.6 5136.7 5140.6 5140.9 5149.6 5155.0 5400.4 5496.1 5585.3 5586.2 5605.6 5391.5 5412.5 5439.4 5440.6 5492.5 5393.1 5411.5 5411.6 5412.6 5416.7 5361.2 5368.9 5382.9 5426.3 5449.6 5449.3 5455.9 5467.9 5474.1 5492.2 4283.8 4287.8 4298.5 4329.5 4336.1 3782.6 3794.5 3815.5 3833.8 3847.9 5058.9 5083.5 5083.9 5085.6 5120.1 5358.4 5410.0 5410.6 5418.1 5447.4 5013.2 5062.9 5071.8 5116.6 5140.5 4655.9 4657.3 4663.2 4680.3 4707.2 5507.9 5610.1 5611.8 5625.1 5625.3 5335.2 5444.3 5486.5 5499.8 5506.3 5588.0 5601.2 5602.6 5602.9 5604.8 5266.1 5348.9 5354.1 5354.4 5400.0 5550.1 5556.5 5570.4 5600.8 5613.2 5367.2 5387.1 5397.7 5405.6 5411.1 5297.1 5362.1 5425.9 5430.5 5449.6 5292.5 5348.8 5367.4 5382.7 5400.8 5300.1 5328.8 5342.2 5354.1 5379.5 5220.3 5235.2 5257.9 5258.5 5271.1 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#1] ext.html Cycles:180 Average:48830.74 Median:36069.23 stddev:85236.87 (236.3%) stddev-sans-first:85398.80 23:25:02 INFO - PROCESS | 28616 | Values: 519.7 536.0 547.0 559.0 574.7 28750.1 36227.5 37052.0 37119.3 37120.5 40723.4 41076.6 41166.8 41177.4 41331.6 8519.5 8722.0 8727.1 8733.7 8742.8 8552.7 8655.4 8700.3 8706.8 8952.7 8886.2 8985.1 8996.7 8997.5 9007.2 8874.8 8965.5 8966.6 8968.3 8979.1 8771.7 8915.1 8915.1 8928.3 8928.4 39437.2 39909.6 39981.0 39984.2 40001.4 3096.2 3192.9 3213.2 3266.2 3719.3 28053.8 28211.4 28652.6 28657.3 28663.3 3859.0 3941.9 3949.6 3973.5 3976.6 274283.0 280670.0 281145.0 281178.0 281361.0 61513.7 65022.3 65489.7 65875.0 66031.7 59924.4 67970.0 68420.3 68618.7 68698.7 15952.9 16322.6 16394.5 16461.6 16468.2 10078.7 11362.0 11532.1 12176.6 12370.3 20605.0 20909.6 20963.7 21153.0 21177.3 8392.7 8570.4 8639.5 8866.2 8926.5 917.5 922.1 973.2 989.4 1068.3 28694.7 28983.3 29079.9 29081.9 29363.9 1014.1 1032.5 1042.4 1076.7 1120.2 15280.8 15364.3 15519.0 16371.4 16641.3 378400.0 381455.0 383467.0 384787.0 384825.0 54835.2 55151.7 55239.7 55277.4 55317.7 1403.7 1404.7 1433.2 1433.5 1443.0 29798.7 30565.5 30654.8 30978.7 31304.7 46111.5 46564.8 46786.3 46867.5 46906.0 300902.0 301697.0 302101.0 302192.0 303254.0 27795.9 31168.4 31477.2 31766.8 31784.5 36613.5 37667.6 37805.4 37980.0 38283.8 32507.3 34496.8 34667.0 34726.3 35292.6 27806.4 33730.8 34741.0 34791.1 35911.0 34542.3 34656.8 35407.3 35778.1 35782.5 29708.3 31129.2 31484.4 31583.7 31652.2 24369.8 24410.6 24435.5 24793.0 24846.0 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#2] jquery.html Cycles:180 Average:28848.99 Median:364.71 stddev:93114.10 (25530.9%) stddev-sans-first:93350.73 23:25:02 INFO - PROCESS | 28616 | Values: 355.9 356.3 359.8 363.3 366.1 15960.0 16319.9 17042.0 17123.9 17205.1 16780.5 17041.1 17116.2 17220.1 17548.1 5233.7 5240.4 5334.8 5405.6 5409.7 5319.8 5365.1 5374.1 5379.1 5381.6 3957.9 4097.8 5146.4 5298.7 5648.7 5535.3 5790.0 5817.4 5823.9 5824.8 5105.8 5127.2 5133.2 5133.6 5134.2 15662.8 18286.7 18956.5 19063.9 19284.7 2015.6 2191.0 2269.6 2504.2 2607.4 11864.2 12068.3 12189.5 12581.3 12745.7 1743.1 1847.8 1870.4 1885.4 1982.4 58370.0 59633.0 60528.7 62136.7 62355.0 9412.4 9574.6 9847.6 9865.3 9878.1 12760.3 12770.0 12796.7 12810.0 12845.4 7412.0 7455.9 7671.8 7736.4 7748.7 7344.5 7349.2 7529.3 7611.7 7655.7 5922.0 5935.0 5943.8 5968.8 5986.8 1719.6 1776.7 1777.4 1778.7 1828.4 750.0 808.1 809.4 845.3 886.4 14248.6 15997.0 16376.8 16395.0 18016.0 953.0 985.8 997.7 1014.5 1053.8 8066.6 9375.4 9519.3 9540.7 10045.7 557340.0 568653.0 570540.0 571368.0 582193.0 66914.3 68616.7 68955.3 77972.6 79753.6 1146.2 1149.4 1154.9 1194.6 1197.8 14559.7 14730.7 14915.3 15114.2 15176.2 32680.8 33113.2 34279.3 34806.7 35057.5 47513.5 47522.0 49051.8 49638.0 49960.0 7566.1 7811.8 7842.5 7945.2 7947.6 10112.6 11759.4 11996.1 12199.6 12358.7 9749.2 10003.9 10457.9 10518.5 10687.7 10073.1 10128.9 10408.8 10532.8 10537.3 10559.8 10713.1 10908.8 11068.3 11204.5 5811.5 6713.7 7652.9 7740.2 8090.6 10221.8 10241.0 10462.2 10556.7 10749.1 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#3] mootools.html Cycles:180 Average:5490.10 Median:6305.48 stddev:2851.03 (45.2%) stddev-sans-first:2841.89 23:25:02 INFO - PROCESS | 28616 | Values: 1330.9 1448.4 1458.9 1618.4 1787.1 6853.4 7270.8 7360.4 7405.1 7434.1 7522.1 7729.1 7733.3 7747.0 7750.0 1996.7 2035.3 2039.5 2260.5 2295.7 2289.9 2323.2 2331.4 2337.0 2343.9 2270.6 2279.9 2297.6 2326.3 2328.4 2234.3 2245.6 2252.1 2254.5 2312.5 2269.1 2273.2 2275.8 2288.9 2290.2 7846.1 7893.3 7909.3 7909.7 7914.9 4633.5 4695.6 4721.6 4740.3 4742.4 3093.9 3114.2 3175.3 3180.8 3192.3 1020.3 1033.2 1070.0 1082.0 1107.9 10785.1 10793.6 10795.9 10815.6 10815.7 4299.6 4320.6 4376.0 4398.9 4407.1 9227.9 9239.6 9265.5 9267.6 9274.9 4831.3 4834.4 4838.8 4840.6 4847.2 4342.0 4380.3 4386.4 4388.3 4397.8 3362.0 3547.4 3635.1 3659.5 3759.2 1162.5 1170.4 1172.2 1174.3 1177.7 1026.2 1047.9 1048.3 1166.3 1305.4 7231.3 7245.4 7263.5 7286.5 7325.5 1103.0 1105.8 1110.2 1125.1 1131.9 5700.1 5857.9 5860.2 5864.0 5869.3 9438.8 9452.4 9527.3 9684.7 9718.5 9455.4 9515.3 9581.8 9596.7 9609.3 7267.6 7478.6 7516.8 7536.3 7539.9 7178.3 7201.3 7234.2 7238.6 7239.0 8294.8 8432.3 8473.4 8490.6 8583.1 8680.5 8724.6 8743.8 8925.8 8943.2 6996.7 7058.1 7063.1 7066.1 7070.5 6337.4 7040.9 7260.9 7263.3 7579.6 6987.1 7080.3 7114.9 7169.4 7192.7 6866.3 6875.3 6911.5 7017.1 7036.8 7086.8 7120.0 7128.2 7129.5 7132.8 6273.5 6390.7 6416.2 6437.9 6549.1 6493.7 6519.8 6521.9 6536.0 6549.2 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#4] prototype.html Cycles:180 Average:5243.92 Median:5894.97 stddev:1558.94 (26.4%) stddev-sans-first:1519.17 23:25:02 INFO - PROCESS | 28616 | Values: 336.3 340.2 340.7 342.3 348.9 5702.6 5782.2 5818.8 5865.9 5914.3 5682.5 5806.7 5820.1 5828.4 5838.4 4564.5 4574.9 4578.2 4579.2 4587.5 4347.8 4438.8 4483.8 4512.1 4565.4 4406.8 4473.7 4486.8 4495.0 4499.3 4469.6 4478.4 4531.7 4537.7 4546.6 4028.7 4034.7 4035.8 4037.2 4040.9 5481.6 5580.2 5595.7 5648.3 5650.5 5195.8 5196.3 5200.7 5201.7 5207.4 5875.6 6255.4 6266.6 6270.6 6274.3 4294.1 4377.7 4406.8 4420.5 4421.6 6373.8 6414.1 6471.7 6476.4 6500.0 4536.1 4550.6 4550.8 4553.0 4553.4 4512.8 4621.4 4621.5 4621.9 4640.8 5211.9 5257.6 5259.4 5266.7 5270.9 6200.5 6236.7 6247.4 6253.6 6257.5 1596.6 1621.9 1624.2 1624.4 1629.3 1110.7 1120.0 1122.2 1122.4 1151.1 5944.1 5954.7 5970.0 6022.3 6024.4 6418.6 6425.1 6437.4 6447.1 6449.8 5851.9 5945.0 5945.2 5952.5 5974.1 3429.7 3483.9 3487.4 3488.1 3494.2 6631.8 6684.0 6694.4 6697.9 6701.4 6534.4 6543.2 6548.4 6551.1 6560.0 6482.3 6677.7 6681.8 6688.1 6699.0 6232.4 6377.3 6398.4 6414.3 6474.0 6281.7 6386.7 6387.1 6387.1 6396.6 6743.6 6749.1 6758.9 6762.5 6767.7 4447.2 4470.1 4570.2 4600.9 4603.9 6492.6 6502.3 6504.8 6506.6 6515.3 6319.3 6325.4 6326.7 6334.1 6335.4 6156.6 6315.1 6317.7 6318.7 6320.8 6165.8 6180.6 6201.8 6202.3 6219.6 6333.1 6337.7 6343.8 6346.1 6346.4 5988.0 6195.7 6198.8 6204.0 6210.9 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - PROCESS | 28616 | [#5] yui.html Cycles:180 Average:12998.94 Median:44389.56 stddev:14508.47 (32.7%) stddev-sans-first:14519.68 23:25:02 INFO - PROCESS | 28616 | Values: 682.7 741.5 772.1 792.4 797.3 13439.5 13799.2 13801.9 13803.4 13811.8 12988.9 13055.5 13056.5 13061.9 13063.8 662.4 669.0 796.7 797.8 813.4 805.7 807.9 811.2 812.4 814.4 697.9 839.6 846.7 847.1 848.4 699.8 699.8 700.8 832.7 850.9 630.4 630.4 630.6 630.9 631.5 12961.4 13022.2 13025.9 13042.5 13057.2 12335.1 12487.6 12696.1 12975.7 13066.9 9429.0 9663.9 9775.3 9939.1 10260.6 3583.8 3620.4 3660.7 3747.2 3755.1 46104.8 47222.5 47919.5 48147.0 48334.0 9858.5 10056.7 10077.8 10099.0 10119.6 17285.2 17287.1 17302.7 17316.9 17351.4 7453.5 7478.3 7484.6 7526.4 7634.8 4113.3 4132.6 4165.9 4180.4 4295.9 3205.4 3221.9 3229.1 3239.5 3248.0 584.4 598.9 604.3 642.6 662.3 675.1 678.5 684.5 689.9 703.7 7701.3 8276.8 8348.1 8352.8 8420.7 515.4 526.5 548.4 563.0 573.3 3534.8 3757.3 3940.7 3948.1 4041.8 46949.3 48344.8 48622.3 48865.3 49044.8 43797.0 44026.1 44672.0 44817.3 49694.3 43970.6 44253.0 44274.3 44343.1 44436.0 7855.9 7932.0 8145.2 8171.4 8270.3 32616.8 32794.3 33246.5 33492.0 34199.0 39745.6 40232.0 40602.6 40869.2 42547.8 10672.9 11080.5 11278.9 11279.0 11356.9 11512.6 11563.7 11729.3 11803.7 12042.6 10332.3 10945.3 11078.3 11300.8 11411.1 10958.5 11166.0 11368.0 11406.6 11665.7 10865.0 11012.3 11013.8 11029.2 11496.5 8481.9 8691.6 8765.9 9016.1 9361.5 7921.8 8204.7 8402.0 8615.2 8899.0 23:25:02 INFO - PROCESS | 28616 | -------- Summary: end -------- 23:25:02 INFO - PROCESS | 28616 | 23:25:02 INFO - TEST-INFO | 28616: exit 0 23:25:02 INFO - TEST-OK | dromaeo_css | took 1113857ms 23:25:02 INFO - TEST-START | kraken 23:25:02 INFO - operating with platform_type : linux_ 23:25:02 INFO - Initialising browser for kraken test... 23:25:02 INFO - TEST-INFO | started process 28801 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPqNlxu/profile http://localhost:46753/getInfo.html) 23:25:06 INFO - PROCESS | 28801 | __metrics Screen width/height:1600/1200 23:25:06 INFO - PROCESS | 28801 | colorDepth:24 23:25:06 INFO - PROCESS | 28801 | Browser inner width/height: 1024/697 23:25:06 INFO - PROCESS | 28801 | __metrics 23:25:07 INFO - PROCESS | 28801 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:25:08 INFO - PROCESS | 28801 | 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. 23:25:08 INFO - TEST-INFO | 28801: exit 0 23:25:08 INFO - Browser initialized. 23:25:08 INFO - Running cycle 1/1 for kraken test... 23:25:08 INFO - TEST-INFO | started process 28882 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPqNlxu/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:25:20 INFO - PROCESS | 28882 | RSS: Main: 150114304 23:25:20 INFO - PROCESS | 28882 | 23:25:22 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46753/tests/kraken/driver.html?testName=audio-beat-detection) 23:25:23 INFO - PROCESS | 28882 | RSS: Main: 193540096 23:25:23 INFO - PROCESS | 28882 | 23:25:26 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46753/tests/kraken/driver.html?testName=audio-dft) 23:25:26 INFO - PROCESS | 28882 | RSS: Main: 182726656 23:25:26 INFO - PROCESS | 28882 | 23:25:29 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46753/tests/kraken/driver.html?testName=audio-fft) 23:25:30 INFO - PROCESS | 28882 | RSS: Main: 165949440 23:25:30 INFO - PROCESS | 28882 | 23:25:32 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46753/tests/kraken/driver.html?testName=audio-oscillator) 23:25:32 INFO - PROCESS | 28882 | RSS: Main: 167022592 23:25:32 INFO - PROCESS | 28882 | 23:25:35 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46753/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:25:35 INFO - PROCESS | 28882 | RSS: Main: 170647552 23:25:35 INFO - PROCESS | 28882 | 23:25:38 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46753/tests/kraken/driver.html?testName=imaging-darkroom) 23:25:39 INFO - PROCESS | 28882 | RSS: Main: 169148416 23:25:39 INFO - PROCESS | 28882 | 23:25:42 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46753/tests/kraken/driver.html?testName=imaging-desaturate) 23:25:43 INFO - PROCESS | 28882 | RSS: Main: 172371968 23:25:43 INFO - PROCESS | 28882 | 23:25:46 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46753/tests/kraken/driver.html?testName=json-parse-financial) 23:25:46 INFO - PROCESS | 28882 | RSS: Main: 172097536 23:25:46 INFO - PROCESS | 28882 | 23:25:48 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46753/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:25:48 INFO - PROCESS | 28882 | RSS: Main: 183267328 23:25:48 INFO - PROCESS | 28882 | 23:25:50 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:25:51 INFO - PROCESS | 28882 | RSS: Main: 179167232 23:25:51 INFO - PROCESS | 28882 | 23:25:53 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:25:53 INFO - PROCESS | 28882 | RSS: Main: 196747264 23:25:53 INFO - PROCESS | 28882 | 23:25:56 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:25:56 INFO - PROCESS | 28882 | RSS: Main: 202862592 23:25:56 INFO - PROCESS | 28882 | 23:25:59 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:25:59 INFO - PROCESS | 28882 | RSS: Main: 199761920 23:25:59 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | Cycle 1(1): loaded http://localhost:46753/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46753/tests/kraken/driver.html?testName=ai-astar) 23:26:01 INFO - PROCESS | 28882 | RSS: Main: 259645440 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | __start_tp_report 23:26:01 INFO - PROCESS | 28882 | _x_x_mozilla_page_load 23:26:01 INFO - PROCESS | 28882 | _x_x_mozilla_page_load_details 23:26:01 INFO - PROCESS | 28882 | |i|pagename|runs| 23:26:01 INFO - PROCESS | 28882 | |0;ai-astar;109;110;105;111;111;112;102;112;110;118 23:26:01 INFO - PROCESS | 28882 | |1;audio-beat-detection;150;128;159;169;125;153;160;127;167;126 23:26:01 INFO - PROCESS | 28882 | |2;audio-dft;162;162;162;161;161;161;161;162;160;161 23:26:01 INFO - PROCESS | 28882 | |3;audio-fft;76;75;101;100;74;73;82;110;93;72 23:26:01 INFO - PROCESS | 28882 | |4;audio-oscillator;96;95;142;95;96;96;140;95;96;140 23:26:01 INFO - PROCESS | 28882 | |5;imaging-gaussian-blur;119;115;115;114;115;114;115;115;114;114 23:26:01 INFO - PROCESS | 28882 | |6;imaging-darkroom;146;146;145;145;146;146;145;146;146;145 23:26:01 INFO - PROCESS | 28882 | |7;imaging-desaturate;97;96;96;96;96;96;96;97;96;96 23:26:01 INFO - PROCESS | 28882 | |8;json-parse-financial;55;57;56;58;57;57;57;66;55;56 23:26:01 INFO - PROCESS | 28882 | |9;json-stringify-tinderbox;67;68;66;66;68;67;66;67;67;67 23:26:01 INFO - PROCESS | 28882 | |10;stanford-crypto-aes;82;81;81;82;82;90;82;82;82;82 23:26:01 INFO - PROCESS | 28882 | |11;stanford-crypto-ccm;122;121;130;121;123;117;119;123;122;119 23:26:01 INFO - PROCESS | 28882 | |12;stanford-crypto-pbkdf2;169;143;157;152;153;150;157;152;153;153 23:26:01 INFO - PROCESS | 28882 | |13;stanford-crypto-sha256-iterative;70;70;70;71;71;70;69;72;70;70 23:26:01 INFO - PROCESS | 28882 | __end_tp_report 23:26:01 INFO - PROCESS | 28882 | __start_cc_report 23:26:01 INFO - PROCESS | 28882 | _x_x_mozilla_cycle_collect,981 23:26:01 INFO - PROCESS | 28882 | __end_cc_report 23:26:01 INFO - PROCESS | 28882 | __startTimestamp1455607561934__endTimestamp 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | ------- Summary: start ------- 23:26:01 INFO - PROCESS | 28882 | Number of tests: 14 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#0] ai-astar Cycles:10 Average:110.00 Median:111.00 stddev:4.27 (3.8%) stddev-sans-first:4.51 23:26:01 INFO - PROCESS | 28882 | Values: 109.0 110.0 105.0 111.0 111.0 112.0 102.0 112.0 110.0 118.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#1] audio-beat-detection Cycles:10 Average:146.40 Median:156.00 stddev:18.03 (11.6%) stddev-sans-first:19.07 23:26:01 INFO - PROCESS | 28882 | Values: 150.0 128.0 159.0 169.0 125.0 153.0 160.0 127.0 167.0 126.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.67 (0.4%) stddev-sans-first:0.67 23:26:01 INFO - PROCESS | 28882 | Values: 162.0 162.0 162.0 161.0 161.0 161.0 161.0 162.0 160.0 161.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#3] audio-fft Cycles:10 Average:85.60 Median:74.50 stddev:14.10 (18.9%) stddev-sans-first:14.53 23:26:01 INFO - PROCESS | 28882 | Values: 76.0 75.0 101.0 100.0 74.0 73.0 82.0 110.0 93.0 72.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#4] audio-oscillator Cycles:10 Average:109.10 Median:95.50 stddev:21.79 (22.8%) stddev-sans-first:22.59 23:26:01 INFO - PROCESS | 28882 | Values: 96.0 95.0 142.0 95.0 96.0 96.0 140.0 95.0 96.0 140.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#5] imaging-gaussian-blur Cycles:10 Average:115.00 Median:115.00 stddev:1.49 (1.3%) stddev-sans-first:0.53 23:26:01 INFO - PROCESS | 28882 | Values: 119.0 115.0 115.0 114.0 115.0 114.0 115.0 115.0 114.0 114.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 23:26:01 INFO - PROCESS | 28882 | Values: 146.0 146.0 145.0 145.0 146.0 146.0 145.0 146.0 146.0 145.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#7] imaging-desaturate Cycles:10 Average:96.20 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 23:26:01 INFO - PROCESS | 28882 | Values: 97.0 96.0 96.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#8] json-parse-financial Cycles:10 Average:57.40 Median:57.00 stddev:3.17 (5.6%) stddev-sans-first:3.24 23:26:01 INFO - PROCESS | 28882 | Values: 55.0 57.0 56.0 58.0 57.0 57.0 57.0 66.0 55.0 56.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#9] json-stringify-tinderbox Cycles:10 Average:66.90 Median:67.00 stddev:0.74 (1.1%) stddev-sans-first:0.78 23:26:01 INFO - PROCESS | 28882 | Values: 67.0 68.0 66.0 66.0 68.0 67.0 66.0 67.0 67.0 67.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#10] stanford-crypto-aes Cycles:10 Average:82.60 Median:82.00 stddev:2.63 (3.2%) stddev-sans-first:2.78 23:26:01 INFO - PROCESS | 28882 | Values: 82.0 81.0 81.0 82.0 82.0 90.0 82.0 82.0 82.0 82.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#11] stanford-crypto-ccm Cycles:10 Average:121.70 Median:122.00 stddev:3.50 (2.9%) stddev-sans-first:3.71 23:26:01 INFO - PROCESS | 28882 | Values: 122.0 121.0 130.0 121.0 123.0 117.0 119.0 123.0 122.0 119.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:153.90 Median:153.00 stddev:6.59 (4.3%) stddev-sans-first:4.15 23:26:01 INFO - PROCESS | 28882 | Values: 169.0 143.0 157.0 152.0 153.0 150.0 157.0 152.0 153.0 153.0 23:26:01 INFO - PROCESS | 28882 | 23:26:01 INFO - PROCESS | 28882 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.30 Median:70.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 23:26:01 INFO - PROCESS | 28882 | Values: 70.0 70.0 70.0 71.0 71.0 70.0 69.0 72.0 70.0 70.0 23:26:01 INFO - PROCESS | 28882 | -------- Summary: end -------- 23:26:01 INFO - PROCESS | 28882 | 23:26:02 INFO - TEST-INFO | 28882: exit 0 23:26:02 INFO - TEST-OK | kraken | took 60094ms 23:26:02 INFO - SUITE-END | took 1173s 23:26:03 INFO - Completed test suite (00:19:34) 23:26:03 INFO - Working with test: dromaeo_css 23:26:03 INFO - Generating results file: dromaeo_css 23:26:03 INFO - Working with test: kraken 23:26:03 INFO - Generating results file: kraken 23:26:03 INFO - javascript benchmark 23:26:03 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 23:26:03 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 23:26:03 INFO - process_Request line: dromaeo_css 6851.59 graph.html#tests=[[72,64,35]] 23:26:03 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 23:26:03 INFO - process_Request line: kraken 1522.00 graph.html#tests=[[232,64,35]] 23:26:03 INFO - RETURN: dromaeo_css: 6851.59 23:26:03 INFO - RETURN: kraken: 1522.00 23:26:03 INFO - javascript benchmark 23:26:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3082.0445661844824, 3096.1640357103597, 3139.4035133324664, 3143.135637699631, 3199.2801619635584, 4920.237363208699, 5043.420006699231, 5060.114479966005, 5112.0, 5126.718030508325, 5019.824306149286, 5022.347094877661, 5032.6477146599755, 5040.445550989388, 5065.544101030907, 4641.9071618567605, 4668.369770081038, 4736.81052757891, 4763.38076050113, 4769.642276829234, 4577.290519969393, 4593.219152744042, 4723.36234608327, 4737.952620473786, 4852.951470485285, 4685.718856868599, 4690.108879312919, 4701.623870090384, 4720.527947205286, 4756.167670657621, 4688.156131896258, 4703.905921881577, 4716.268978308368, 4721.952780472186, 4745.525447455261, 4594.264917613199, 4640.976795116003, 4676.812927482896, 4686.484486706459, 4702.988857395642, 4986.975065124688, 5000.349954505891, 5024.773885175176, 5033.622478314104, 5057.241413787924, 5362.973185134049, 5487.64330318528, 5491.505764481216, 5500.28496295483, 5509.917351239735, 5368.463153684639, 5405.864853378697, 5446.482584154499, 5457.045017121988, 5495.6153069285165, 5136.74316284188, 5140.640155189101, 5140.897182056338, 5149.639525233272, 5155.046316431435, 5400.405955344909, 5496.065668836308, 5585.273914391184, 5586.24585680936, 5605.635633683797, 5391.514763671288, 5412.539934105645, 5439.401665816757, 5440.564754819605, 5492.47821456961, 5393.110136827458, 5411.540019098342, 5411.567074634098, 5412.648177868505, 5416.660454900096, 5361.249425080492, 5368.865778355573, 5382.91925621116, 5426.321709786277, 5449.618526703092, 5449.3460784706085, 5455.918161227585, 5467.890642187213, 5474.09677403224, 5492.231087647732, 4283.807228674717, 4287.807048682755, 4298.484181898192, 4329.523752387235, 4336.132773445323, 3782.6028267032116, 3794.487744154559, 3815.465834783133, 3833.8083095845095, 3847.9038024049623, 5058.924116138261, 5083.542481176712, 5083.949160508348, 5085.593152547787, 5120.129577971754, 5358.4373640767935, 5409.999150157233, 5410.567154627621, 5418.051840927822, 5447.400785913546, 5013.222950442687, 5062.924056139161, 5071.822486212965, 5116.590672746172, 5140.460251673595, 4655.86032419028, 4657.347971284023, 4663.230566956482, 4680.251159814414, 4707.176244157259, 5507.889842203133, 5610.1304297833085, 5611.803586874522, 5625.071863142535, 5625.296837895263, 5335.226392173191, 5444.265024221838, 5486.451354864482, 5499.835004949858, 5506.339239291311, 5588.0, 5601.243832082617, 5602.579806514609, 5602.887942241214, 5604.8318550443555, 5266.078436273713, 5348.866278343073, 5354.063038968243, 5354.384245811626, 5399.973000134974, 5550.111982083009, 5556.527695145796, 5570.4151064139305, 5600.803971860965, 5613.242212301287, 5367.248585197997, 5387.0572649785345, 5397.730113494388, 5405.648632838853, 5411.080116380146, 5297.125974214211, 5362.088444964287, 5425.891482170414, 5430.456954304538, 5449.64577302474, 5292.52367286946, 5348.839534813962, 5367.409584945731, 5382.67703937765, 5400.83797486076, 5300.1254792958725, 5328.786848526015, 5342.225377320345, 5354.089804733127, 5379.462053794589, 5220.321358223407, 5235.1623740201385, 5257.894842103213, 5258.50044245796, 5271.051210782096], "unit": "score", "name": "dojo.html", "value": 5049.431969131794}, {"lowerIsBetter": false, "replicates": [519.7479222577052, 536.0244355273403, 547.0208327094501, 559.0356634804962, 574.7298769578299, 28750.13749587513, 36227.456588151166, 37052.0, 37119.25761484769, 37120.47355501223, 40723.389149162715, 41076.58923410765, 41166.794166029205, 41177.382339264936, 41331.58668413315, 8519.488830670163, 8722.0, 8727.0836562161, 8733.650653973833, 8742.825143497126, 8552.743417697478, 8655.350848686343, 8700.303975681962, 8706.782330441727, 8952.686655967042, 8886.20024197822, 8985.146411090936, 8996.68511602094, 8997.505137217451, 9007.189352958232, 8874.778130546723, 8965.506897120657, 8966.551672416419, 8968.327375446803, 8979.057198994076, 8771.736847894574, 8915.063918288615, 8915.108489151098, 8928.330375221884, 8928.37501374904, 39437.21125577501, 39909.60090399088, 39981.0, 39984.20031599381, 40001.399979000045, 3096.1949893027977, 3192.8563214655396, 3213.1645772099423, 3266.1508007917873, 3719.3491139050557, 28053.810045141716, 28211.435771284665, 28652.570211446844, 28657.28356791097, 28663.28341791451, 3858.961410385916, 3941.9211615767813, 3949.605039496056, 3973.4834471518807, 3976.642102210786, 274283.0, 280670.0, 281144.99999999796, 281178.0, 281361.0, 61513.69243153756, 65022.34977650163, 65489.67255163693, 65875.0, 66031.66984165048, 59924.400755992756, 67970.0, 68420.31579684239, 68618.65690671514, 68698.65650671815, 15952.92023539875, 16322.591935201477, 16394.508164755076, 16461.58846028835, 16468.176591170395, 10078.748031299276, 11362.0, 11532.077433805276, 12176.634700958986, 12370.257784532956, 20605.0, 20909.581808363746, 20963.685544716842, 21153.0, 21177.258795942067, 8392.664293428195, 8570.400071995025, 8639.524826134497, 8866.20204181614, 8926.464412135163, 917.5412293853074, 922.1285884838763, 973.1825266775942, 989.44096585429, 1068.3048004022278, 28694.713052869203, 28983.275418114717, 29079.854600727285, 29081.854590727333, 29363.85318073396, 1014.1481155828991, 1032.488917985602, 1042.3693665332517, 1076.6608518316705, 1120.1990576737671, 15280.770788438182, 15364.308606112752, 15519.0, 16371.42700005494, 16641.251143698322, 378400.0, 381455.0, 383467.0, 384787.0, 384825.0, 54835.17747233795, 55151.724241379336, 55239.72380138074, 55277.447225528034, 55317.723411382685, 1403.7262733766818, 1404.7331007108617, 1433.2117335465243, 1433.4767809749576, 1442.9711405772036, 29798.70201298046, 30565.54151687771, 30654.77380904828, 30978.69021309848, 31304.686953130178, 46111.53888461207, 46564.7671761639, 46786.29820552626, 46867.531324686315, 46906.0, 300902.0, 301697.0, 302101.0, 302192.0, 303254.0, 27795.861020694767, 31168.376632467676, 31477.213069673442, 31766.841165794023, 31784.523232151998, 36613.450798238584, 37667.623323767504, 37805.43291850569, 37980.0, 38283.80858095692, 32507.34985300328, 34496.82751586326, 34667.0, 34726.30547388987, 35292.64707352893, 27806.44387112287, 33730.831345843115, 34741.0, 34791.13022174466, 35911.0, 34542.33678453376, 34656.82671586626, 35407.29185416329, 35778.10554736153, 35782.46326305055, 29708.257293567833, 31129.221769455038, 31484.370312594077, 31583.684163158076, 31652.208694782814, 24369.756302437458, 24410.633840492053, 24435.511289774462, 24793.0, 24846.0], "unit": "score", "name": "ext.html", "value": 18670.313569680624}, {"lowerIsBetter": false, "replicates": [355.9092431429985, 356.3194298889122, 359.8236863936671, 363.3314700950251, 366.09026568976105, 15960.0, 16319.918400407996, 17042.0, 17123.914380428098, 17205.13974301283, 16780.496585102468, 17041.147942602853, 17116.229769660364, 17220.13899305036, 17548.12259387032, 5233.685978841263, 5240.397354304266, 5334.759935802879, 5405.594580406466, 5409.702466364349, 5319.840404787863, 5365.087935051031, 5374.113271310249, 5379.058664733676, 5381.569474442055, 3957.861474848381, 4097.754134751909, 5146.433892271847, 5298.682079075268, 5648.661080335172, 5535.335759708861, 5789.971050144764, 5817.41825817417, 5823.854403639901, 5824.767009319643, 5105.846824595268, 5127.230915362688, 5133.204353325241, 5133.640645154841, 5134.17853143499, 15662.765058524132, 18286.725699114522, 18956.5260868478, 19063.904680476648, 19284.710729339073, 2015.5602848897777, 2190.9561808763738, 2269.6028195065965, 2504.248725382378, 2607.374230184761, 11864.169508134433, 12068.275903445734, 12189.451474683661, 12581.308028058453, 12745.661705520879, 1743.0935913325, 1847.7875044369935, 1870.4201697473827, 1885.3589779475044, 1982.4350060232764, 58370.0, 59633.0, 60528.69735651294, 62136.68931655313, 62355.0, 9412.388194767318, 9574.617015319309, 9847.606095756233, 9865.260105492116, 9878.110970012733, 12760.29818359999, 12770.0, 12796.680082997813, 12810.0, 12845.421956012002, 7411.962940185264, 7455.888161677579, 7671.808204794925, 7736.381089512825, 7748.651310691032, 7344.522606030698, 7349.191588925214, 7529.284717951896, 7611.657475413509, 7655.655495502716, 5921.970390148022, 5934.970325148433, 5943.821685349447, 5968.761249550056, 5986.760529578855, 1719.5701074731317, 1776.6979613465742, 1777.3564193403472, 1778.6531626332742, 1828.4240464253717, 749.9587522686305, 808.0626473290954, 809.402207189039, 845.2646197807946, 886.3529623374843, 14248.572542823731, 15997.0, 16376.83623163777, 16395.0, 18016.0, 953.0, 985.7929834734642, 997.6930221409976, 1014.4927536231884, 1053.8261186904228, 8066.596670166468, 9375.390599611004, 9519.333646644669, 9540.712003879526, 10045.748856278651, 557340.0, 568653.037552566, 570540.0, 571368.0, 582193.0, 66914.33085669081, 68616.65691671609, 68955.31044689589, 77972.61013694895, 79753.60123199347, 1146.2377518949972, 1149.373591392693, 1154.872963973979, 1194.5639841457978, 1197.802362610177, 14559.708805823613, 14730.705385892008, 14915.254237288309, 15114.168720720467, 15176.165310908005, 32680.83659581687, 33113.17217069593, 34279.31441371109, 34806.65193348034, 35057.47413788744, 47513.52486475091, 47522.0, 49051.75474122607, 49638.0, 49960.0, 7566.092068951541, 7811.804704882424, 7842.451028427955, 7945.205479452008, 7947.642356093874, 10112.59549618007, 11759.353235572125, 11996.100292477924, 12199.57301494479, 12358.691032723895, 9749.220062395134, 10003.949980250052, 10457.895421045996, 10518.526666299882, 10687.732806679895, 10073.143782778547, 10128.949355253177, 10408.791824163625, 10532.842007370049, 10537.315074520131, 10559.788804224027, 10713.14294856394, 10908.836367454653, 11068.28056176346, 11204.495797689287, 5811.535077193899, 6713.731450741916, 7652.885206721792, 7740.187280335484, 8090.6359213836695, 10221.846672300071, 10241.0, 10462.215333850145, 10556.736081597714, 10749.086327661924], "unit": "score", "name": "jquery.html", "value": 8435.59835800165}, {"lowerIsBetter": false, "replicates": [1330.9334533273334, 1448.4278709909584, 1458.934347954342, 1618.4254589620684, 1787.0796539782007, 6853.417459515941, 7270.781876543706, 7360.411167106632, 7405.111386633612, 7434.070741157356, 7522.059742532184, 7729.149793522722, 7733.265339792725, 7746.96126519368, 7750.0, 1996.680531115022, 2035.328341647253, 2039.51051747581, 2260.457490202356, 2295.701558797354, 2289.8855057247156, 2323.2101085630884, 2331.3705299569106, 2337.0, 2343.894524746382, 2270.648049552322, 2279.9316020519327, 2297.5519773644146, 2326.3253656439697, 2328.39461739948, 2234.318532847481, 2245.62947113726, 2252.0653928619686, 2254.5152792149684, 2312.5259321838985, 2269.0810221860174, 2273.227102785061, 2275.795178433949, 2288.8626682398944, 2290.244219407608, 7846.136924938252, 7893.250141236574, 7909.327707144899, 7909.7231596893835, 7914.881276780853, 4633.4671512775785, 4695.647826413033, 4721.645876559238, 4740.312654665055, 4742.359781429497, 3093.9381212375624, 3114.205877501223, 3175.333180032196, 3180.8250546219947, 3192.3136525646864, 1020.3265844542566, 1033.2147567848415, 1069.9572017119306, 1081.9505080072395, 1107.916906232036, 10785.083267922237, 10793.622223222228, 10795.946020269848, 10815.621453249098, 10815.729606759814, 4299.613034826881, 4320.611144996902, 4376.037271800199, 4398.934015989763, 4407.118576284756, 9227.90772092284, 9239.584218710173, 9265.490398028038, 9267.629294828266, 9274.90725092754, 4831.275308703653, 4834.419869615669, 4838.806447742051, 4840.6127509799835, 4847.151748444008, 4342.0, 4380.3210502372185, 4386.363977223285, 4388.2759344707765, 4397.846075387346, 3361.966380336214, 3547.396942519778, 3635.0548857297294, 3659.451082337671, 3759.2293579816073, 1162.5117450670568, 1170.3680012792997, 1172.1736175995902, 1174.2954227463624, 1177.6584790410857, 1026.1841835740604, 1047.8847326794046, 1048.3028785857473, 1166.2535976974573, 1305.3929922586044, 7231.2768723127265, 7245.38414234796, 7263.527870688388, 7286.526375785557, 7325.450591205681, 1102.9558817647364, 1105.7677887643524, 1110.189561620022, 1125.0661950580998, 1131.8641762988493, 5700.116481945305, 5857.912131318034, 5860.208871802337, 5864.0, 5869.325027621793, 9438.764030899145, 9452.385594936308, 9527.333086684004, 9684.70945871625, 9718.514074296258, 9455.385399948982, 9515.33392662507, 9581.808363832824, 9596.66411675588, 9609.327347085637, 7267.563946163247, 7478.551286922802, 7516.774496765106, 7536.321731044122, 7539.886901696479, 7178.318059784312, 7201.3158749918675, 7234.240404757636, 7238.565686058853, 7239.0, 8294.792630184294, 8432.32541396699, 8473.364497662824, 8490.617922193393, 8583.098774628574, 8680.479171249493, 8724.56377181151, 8743.825123497367, 8925.821483570162, 8943.23982461498, 6996.650167491707, 7058.082449281561, 7063.081799366049, 7066.081409416743, 7070.540414873017, 6337.429631333202, 7040.929590704232, 7260.927390726025, 7263.309985551364, 7579.583122928292, 6987.1266091738535, 7080.256573059961, 7114.893276600958, 7169.390601798906, 7192.676329565077, 6866.34769696878, 6875.346842049998, 6911.516193866381, 7017.122859642544, 7036.788896333118, 7086.822829429099, 7120.0, 7128.180259270251, 7129.4652901031595, 7132.786016419515, 6273.52948528853, 6390.712417941111, 6416.2300523935555, 6437.871242575216, 6549.083128362128, 6493.707783149864, 6519.8044058678315, 6521.902171467337, 6536.0, 6549.214094308713], "unit": "score", "name": "mootools.html", "value": 4506.781500816042}, {"lowerIsBetter": false, "replicates": [336.32063232270815, 340.20222578054467, 340.6814628322517, 342.3256185314932, 348.8674303764571, 5702.600817942745, 5782.248307719996, 5818.8254352369395, 5865.912011319829, 5914.2902851657755, 5682.545396368291, 5806.7096645167785, 5820.126980952859, 5828.417158284169, 5838.357780644125, 4564.5435456454425, 4574.862754117382, 4578.198815207325, 4579.152856721501, 4587.518310577375, 4347.804348804311, 4438.755868427235, 4483.753393563353, 4512.142692888341, 4565.429321334833, 4406.801693923765, 4473.686841921067, 4486.753228572427, 4494.955050449486, 4499.3475945987975, 4469.642428605704, 4478.35063915732, 4531.728096314232, 4537.727736335831, 4546.613537849286, 4028.7179897407195, 4034.7377420467574, 4035.778032208227, 4037.212743515016, 4040.919181616351, 5481.561475081984, 5580.218769372291, 5595.7481913313595, 5648.265725455664, 5650.5479561634975, 5195.844124676266, 5196.324477817897, 5200.713960732158, 5201.739913004372, 5207.375114986188, 5875.6474611523445, 6255.40573645503, 6266.624002559861, 6270.592411493284, 6274.2784579773, 4294.098239369736, 4377.6935614507, 4406.779661016936, 4420.469543654782, 4421.557844215585, 6373.776917807901, 6414.069959855795, 6471.676416179219, 6476.384743449365, 6500.024996250553, 4536.070105628338, 4550.590446859732, 4550.817967281338, 4553.02110046335, 4553.362529245908, 4512.849223448, 4621.376114224604, 4621.468531118897, 4621.93067103987, 4640.767961601974, 5211.921821172686, 5257.553107985864, 5259.421463638997, 5266.683998960075, 5270.894582108336, 6200.503959683215, 6236.719347629368, 6247.375262473716, 6253.593516421418, 6257.530685198628, 1596.640755829929, 1621.9189040547926, 1624.16355576878, 1624.3908534299637, 1629.3156874112901, 1110.7112150840678, 1119.9664010079712, 1122.1695945000804, 1122.3770807202081, 1151.1366475143643, 5944.0786678064105, 5954.672493012926, 5969.970150149222, 6022.337542870281, 6024.427679370453, 6418.614883106935, 6425.068365087036, 6437.388448097423, 6447.065175549519, 6449.838754031093, 5851.882962340729, 5945.048792193228, 5945.16767652529, 5952.523798096142, 5974.103884417372, 3429.6570342965506, 3483.9477407838904, 3487.4071407860724, 3488.145404375944, 3494.2138018945534, 6631.767888123893, 6683.997400389981, 6694.430973367318, 6697.8995315070315, 6701.430378417889, 6534.444572211415, 6543.247526534509, 6548.377904099103, 6551.115599394021, 6560.048792924999, 6482.319356467598, 6677.732890684415, 6681.766138185238, 6688.063671086052, 6698.966505167443, 6232.439080482778, 6377.266614339411, 6398.360163983564, 6414.294427613052, 6474.028895665688, 6281.748730050929, 6386.744530218925, 6387.105805187184, 6387.137736405526, 6396.584222025554, 6743.5953842769595, 6749.088873002278, 6758.8648227036165, 6762.459003279824, 6767.661616919233, 4447.155040542287, 4470.1059788041875, 4570.154521413549, 4600.930986035279, 4603.884902877455, 6492.64290464029, 6502.252240992158, 6504.772332968323, 6506.642134682448, 6515.348465153446, 6319.273283572448, 6325.430711236011, 6326.652034137983, 6334.113224148531, 6335.366463353628, 6156.5998210116195, 6315.147455093687, 6317.747290108344, 6318.715657795318, 6320.841978950379, 6165.784197553064, 6180.598261113013, 6201.751929922752, 6202.2867370253, 6219.595726277777, 6333.145025421509, 6337.683115844282, 6343.841403964938, 6346.07981842621, 6346.428821406095, 5987.982043052779, 6195.721192546256, 6198.81403557894, 6204.0, 6210.937890621036], "unit": "score", "name": "prototype.html", "value": 4744.638270927761}, {"lowerIsBetter": false, "replicates": [682.7269092363055, 741.5365396627108, 772.1082150116614, 792.4452882981914, 797.2864286463619, 13439.529616463426, 13799.172049677001, 13801.861981380183, 13803.37884795184, 13811.792823107662, 12988.93505532471, 13055.543055993043, 13056.477740890377, 13061.93469032656, 13063.804042939364, 662.374056516592, 669.0232260899094, 796.6972550430828, 797.7566842113154, 813.4427916876929, 805.6857825448051, 807.8868958345836, 811.2131232704268, 812.3907069697726, 814.3810703865075, 697.909271794666, 839.6221700234888, 846.7205822078699, 847.1189962439056, 848.4273115646945, 699.7550857199965, 699.8390370214854, 700.8072779985494, 832.7335252719132, 850.8808766772656, 630.3822254190873, 630.4074170279922, 630.5680608782999, 630.9432151106422, 631.4979591224987, 12961.351932403342, 13022.153560018569, 13025.86974130256, 13042.543510977164, 13057.21656700601, 12335.136540442172, 12487.562935297312, 12696.111272210948, 12975.67560810978, 13066.934665326613, 9428.952855235748, 9663.903360966371, 9775.31572789905, 9939.055789699967, 10260.640877569249, 3583.802890841003, 3620.4207326827845, 3660.7071434285194, 3747.1756213632957, 3755.0987762936697, 46104.76947615274, 47222.527774722155, 47919.52080479186, 48147.0, 48334.0, 9858.507074646239, 10056.69829905104, 10077.798444031077, 10098.990100989842, 10119.645812396531, 17285.222165002353, 17287.13564321779, 17302.740458893128, 17316.913415432842, 17351.39270125565, 7453.478256522099, 7478.326950574475, 7484.625768711543, 7526.397888168934, 7634.847303054019, 4113.280175969194, 4132.628063474302, 4165.875023749292, 4180.372944058355, 4295.892602684896, 3205.4390481665614, 3221.8711251550144, 3229.111994201566, 3239.4654881944684, 3247.9837600811843, 584.4272612839441, 598.8832177725388, 604.3171216525299, 642.6369101457661, 662.2979641579844, 675.1088563096763, 678.5182520410465, 684.4524380495584, 689.9103116594811, 703.6552089476222, 7701.345385642283, 8276.793080173044, 8348.081711011784, 8352.8329433411, 8420.747377578682, 515.3686733751125, 526.4551189518829, 548.363897878459, 562.9894339660319, 573.2604939627917, 3534.840932158059, 3757.342465068602, 3940.7438516496336, 3948.1314110895555, 4041.797910104483, 46949.29576056362, 48344.75827620839, 48622.27066594004, 48865.26702099471, 49044.75477622589, 43797.0, 44026.11947761091, 44672.0, 44817.32774008392, 49694.25458618124, 43970.560294397284, 44253.0, 44274.33588496175, 44343.11313773706, 44436.0, 7855.8501223126395, 7932.0, 8145.185481451807, 8171.428000040178, 8270.2556769891, 32616.836915816217, 32794.34411311808, 33246.50130248097, 33492.0, 34199.0, 39745.60254397535, 40232.0, 40602.59397406106, 40869.1826163481, 42547.787261063495, 10672.89327106719, 11080.501377437873, 11278.943605281922, 11279.0, 11356.94321528387, 11512.589083130915, 11563.710907227387, 11729.296242225493, 11803.704907377385, 12042.578509752117, 10332.328398654063, 10945.343279403261, 11078.279911805706, 11300.773984520429, 11411.087113030771, 10958.506867190836, 11166.0, 11368.0, 11406.600768973378, 11665.708357291136, 10865.022148006718, 11012.284201526874, 11013.83479247828, 11029.172812038969, 11496.48265828023, 8481.915180848113, 8691.565421728761, 8765.912340876765, 9016.143466370684, 9361.485118318558, 7921.841563168819, 8204.712835050745, 8401.95799021001, 8615.22462978335, 8899.0], "unit": "score", "name": "yui.html", "value": 6083.162892834625}], "name": "dromaeo_css", "value": 6851.591590758985}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 110.0, 105.0, 111.0, 111.0, 112.0, 102.0, 112.0, 110.0, 118.0], "unit": "score", "name": "ai-astar", "value": 110.0}, {"lowerIsBetter": true, "replicates": [150.0, 128.0, 159.0, 169.0, 125.0, 153.0, 160.0, 127.0, 167.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 146.4}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 162.0, 161.0, 161.0, 161.0, 161.0, 162.0, 160.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.3}, {"lowerIsBetter": true, "replicates": [76.0, 75.0, 101.0, 100.0, 74.0, 73.0, 82.0, 110.0, 93.0, 72.0], "unit": "score", "name": "audio-fft", "value": 85.6}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 142.0, 95.0, 96.0, 96.0, 140.0, 95.0, 96.0, 140.0], "unit": "score", "name": "audio-oscillator", "value": 109.1}, {"lowerIsBetter": true, "replicates": [119.0, 115.0, 115.0, 114.0, 115.0, 114.0, 115.0, 115.0, 114.0, 114.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.0}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 145.0, 145.0, 146.0, 146.0, 145.0, 146.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.2}, {"lowerIsBetter": true, "replicates": [55.0, 57.0, 56.0, 58.0, 57.0, 57.0, 57.0, 66.0, 55.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 57.4}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 66.0, 66.0, 68.0, 67.0, 66.0, 67.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.9}, {"lowerIsBetter": true, "replicates": [82.0, 81.0, 81.0, 82.0, 82.0, 90.0, 82.0, 82.0, 82.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.6}, {"lowerIsBetter": true, "replicates": [122.0, 121.0, 130.0, 121.0, 123.0, 117.0, 119.0, 123.0, 122.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 121.7}, {"lowerIsBetter": true, "replicates": [169.0, 143.0, 157.0, 152.0, 153.0, 150.0, 157.0, 152.0, 153.0, 153.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 153.9}, {"lowerIsBetter": true, "replicates": [70.0, 70.0, 70.0, 71.0, 71.0, 70.0, 69.0, 72.0, 70.0, 70.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.3}], "name": "kraken", "value": 1522.0000000000002}]} 23:26:03 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1522.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6851.59"}}} 23:26:03 INFO - Return code: 0 23:26:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 23:26:03 INFO - # TBPL SUCCESS # 23:26:03 INFO - Running post-action listener: _resource_record_post_action 23:26:03 INFO - Running post-run listener: _resource_record_post_run 23:26:04 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 0; Write bytes: 539336704; Read time: 0; Write time: 698508 23:26:04 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 240427008; Read time: 0; Write time: 373060 23:26:04 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 298848256; Read time: 0; Write time: 325428 23:26:04 INFO - Running post-run listener: _upload_blobber_files 23:26:04 INFO - Blob upload gear active. 23:26:04 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 23:26:04 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 23:26:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 23:26:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 23:26:04 INFO - (blobuploader) - INFO - Open directory for files ... 23:26:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 23:26:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:26:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:26:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 23:26:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:26:05 INFO - (blobuploader) - INFO - Done attempting. 23:26:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 23:26:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:26:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:26:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 23:26:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:26:06 INFO - (blobuploader) - INFO - Done attempting. 23:26:06 INFO - (blobuploader) - INFO - Iteration through files over. 23:26:06 INFO - Return code: 0 23:26:06 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 23:26:06 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 23:26:06 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b0cd8f664cddc320bf00042e20b44b3fdfddbfb49adb5499d4c2cc4397675e0755b03eac9c5d98ac2c3666ebcc6a997ca75f307b256981d34e7d6e8ea4baf838", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0272820afd08f6a4c60fede9d257ea65c7252747a231184ad15245b7f959505c42dbfa1d00b4fccd4dec42a1ac874dee4544c75c3a4c82c40bc1fcf5f7c8e2a3"} 23:26:06 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 23:26:06 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 23:26:06 INFO - Contents: 23:26:06 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b0cd8f664cddc320bf00042e20b44b3fdfddbfb49adb5499d4c2cc4397675e0755b03eac9c5d98ac2c3666ebcc6a997ca75f307b256981d34e7d6e8ea4baf838", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0272820afd08f6a4c60fede9d257ea65c7252747a231184ad15245b7f959505c42dbfa1d00b4fccd4dec42a1ac874dee4544c75c3a4c82c40bc1fcf5f7c8e2a3"} 23:26:06 INFO - Running post-run listener: copy_logs_to_upload_dir 23:26:06 INFO - Copying logs to upload dir... 23:26:06 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 23:26:06 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.758570 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-02-15 23:26:06.020437) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-15 23:26:06.023827) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b0cd8f664cddc320bf00042e20b44b3fdfddbfb49adb5499d4c2cc4397675e0755b03eac9c5d98ac2c3666ebcc6a997ca75f307b256981d34e7d6e8ea4baf838", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0272820afd08f6a4c60fede9d257ea65c7252747a231184ad15245b7f959505c42dbfa1d00b4fccd4dec42a1ac874dee4544c75c3a4c82c40bc1fcf5f7c8e2a3"} build_url:https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011461 build_url: 'https://queue.taskcluster.net/v1/task/ZfMV7YCyQsqMGSd5tPXH0w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b0cd8f664cddc320bf00042e20b44b3fdfddbfb49adb5499d4c2cc4397675e0755b03eac9c5d98ac2c3666ebcc6a997ca75f307b256981d34e7d6e8ea4baf838", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0272820afd08f6a4c60fede9d257ea65c7252747a231184ad15245b7f959505c42dbfa1d00b4fccd4dec42a1ac874dee4544c75c3a4c82c40bc1fcf5f7c8e2a3"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-15 23:26:06.049250) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:26:06.049587) ========= 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=fa44defc139c4ba8574fe040000001db-1455599324.213702-1017036066 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004569 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 23:26:06.133288) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-15 23:26:06.133673) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-15 23:26:06.134013) ========= ========= Total master_lag: 0.27 =========