builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-036 starttime: 1452985932.42 results: success (0) buildid: 20160116142922 builduid: f46e5698d90541a7b3c5469fcd500b9b revision: c539267331fb152e9d196cf2bedbd0184c71afb8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.419700) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.420440) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.420798) ========= bash -c pwd in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006397 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.450719) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.451029) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.478253) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.478570) ========= rm -rf properties in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004629 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.528130) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.528428) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.528822) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.529139) ========= 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/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-16 15:12:12-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 228M=0s 2016-01-16 15:12:13 (228 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.174561 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.715876) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.716196) ========= rm -rf scripts in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017983 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.766802) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:12.767199) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev c539267331fb152e9d196cf2bedbd0184c71afb8 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev c539267331fb152e9d196cf2bedbd0184c71afb8 --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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-16 15:12:13,218 truncating revision to first 12 chars 2016-01-16 15:12:13,218 Setting DEBUG logging. 2016-01-16 15:12:13,218 attempt 1/10 2016-01-16 15:12:13,218 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/c539267331fb?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-16 15:12:13,610 unpacking tar archive at: fx-team-c539267331fb/testing/mozharness/ program finished with exit code 0 elapsedTime=0.689828 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.473045) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.473448) ========= echo '%(revision)s' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', '%(revision)s'] 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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False %(revision)s program finished with exit code 0 elapsedTime=0.004676 script_repo_revision: '%(revision)s' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.524489) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.524839) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.535683) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.535965) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/%(revision)s ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-16 15:12:13.536366) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 51 secs) (at 2016-01-16 15:12:13.536696) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (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-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:12:14 INFO - MultiFileLogger online at 20160116 15:12:14 in /builds/slave/test 15:12:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 15:12:14 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:12:14 INFO - {'append_to_log': False, 15:12:14 INFO - 'base_work_dir': '/builds/slave/test', 15:12:14 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 15:12:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:12:14 INFO - 'branch': 'Fx-Team-Non-PGO', 15:12:14 INFO - 'buildbot_json_path': 'buildprops.json', 15:12:14 INFO - 'config_files': ('talos/linux_config.py',), 15:12:14 INFO - 'default_actions': ('clobber', 15:12:14 INFO - 'read-buildbot-config', 15:12:14 INFO - 'download-and-extract', 15:12:14 INFO - 'populate-webroot', 15:12:14 INFO - 'create-virtualenv', 15:12:14 INFO - 'install', 15:12:14 INFO - 'run-tests'), 15:12:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:12:14 INFO - 'download_minidump_stackwalk': True, 15:12:14 INFO - 'download_symbols': 'ondemand', 15:12:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:12:14 INFO - 'tooltool.py': '/tools/tooltool.py', 15:12:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:12:14 INFO - '/tools/misc-python/virtualenv.py')}, 15:12:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:12:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:12:14 INFO - 'installer_path': 'installer.exe', 15:12:14 INFO - 'log_level': 'info', 15:12:14 INFO - 'log_name': 'talos', 15:12:14 INFO - 'log_to_console': True, 15:12:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:12:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:12:14 INFO - 'opt_config_files': (), 15:12:14 INFO - 'pip_index': False, 15:12:14 INFO - 'sps_profile': False, 15:12:14 INFO - 'sps_profile_interval': 0, 15:12:14 INFO - 'suite': 'dromaeojs', 15:12:14 INFO - 'system_bits': '32', 15:12:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:12:14 INFO - 'title': 'talos-linux64-ix-036', 15:12:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:12:14 INFO - 'use_talos_json': True, 15:12:14 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:12:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:12:14 INFO - 'work_dir': 'build'} 15:12:14 INFO - ##### 15:12:14 INFO - ##### Running clobber step. 15:12:14 INFO - ##### 15:12:14 INFO - Running pre-action listener: _resource_record_pre_action 15:12:14 INFO - Running main action method: clobber 15:12:14 INFO - rmtree: /builds/slave/test/build 15:12:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:12:14 INFO - Running post-action listener: _resource_record_post_action 15:12:14 INFO - ##### 15:12:14 INFO - ##### Running read-buildbot-config step. 15:12:14 INFO - ##### 15:12:14 INFO - Running pre-action listener: _resource_record_pre_action 15:12:14 INFO - Running main action method: read_buildbot_config 15:12:14 INFO - Using buildbot properties: 15:12:14 INFO - { 15:12:14 INFO - "project": "", 15:12:14 INFO - "product": "firefox", 15:12:14 INFO - "script_repo_revision": "production", 15:12:14 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 15:12:14 INFO - "repository": "", 15:12:14 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 15:12:14 INFO - "buildid": "20160116142922", 15:12:14 INFO - "pgo_build": "False", 15:12:14 INFO - "basedir": "/builds/slave/test", 15:12:14 INFO - "buildnumber": 1146, 15:12:14 INFO - "slavename": "talos-linux64-ix-036", 15:12:14 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:12:14 INFO - "platform": "ubuntu64_hw", 15:12:14 INFO - "scheduler": "tests-fx-team-linux64-talos", 15:12:14 INFO - "branch": "fx-team", 15:12:14 INFO - "repo_path": "integration/fx-team", 15:12:14 INFO - "revision": "c539267331fb152e9d196cf2bedbd0184c71afb8", 15:12:14 INFO - "stage_platform": "linux64", 15:12:14 INFO - "builduid": "f46e5698d90541a7b3c5469fcd500b9b", 15:12:14 INFO - "slavebuilddir": "test" 15:12:14 INFO - } 15:12:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 15:12:14 INFO - Running post-action listener: _resource_record_post_action 15:12:14 INFO - ##### 15:12:14 INFO - ##### Running download-and-extract step. 15:12:14 INFO - ##### 15:12:14 INFO - Running pre-action listener: _resource_record_pre_action 15:12:14 INFO - Running main action method: download_and_extract 15:12:14 INFO - mkdir: /builds/slave/test/build/tests 15:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:14 INFO - https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:12:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/test_packages.json 15:12:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/test_packages.json 15:12:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:12:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:12:15 INFO - Downloaded 1448 bytes. 15:12:15 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:12:15 INFO - Using the following test package requirements: 15:12:15 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 15:12:15 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 15:12:15 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 15:12:15 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'jsshell-linux-x86_64.zip'], 15:12:15 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 15:12:15 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 15:12:15 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 15:12:15 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 15:12:15 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 15:12:15 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 15:12:15 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 15:12:15 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 15:12:15 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:12:15 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')]} 15:12:15 INFO - https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:12:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:12:18 INFO - Downloaded 21172780 bytes. 15:12:18 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:12:18 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:12:19 INFO - Return code: 0 15:12:19 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:12:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:19 INFO - https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:12:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 15:12:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:12:24 INFO - Downloaded 21172780 bytes. 15:12:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:12:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:12:26 INFO - Return code: 0 15:12:26 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')]} 15:12:26 INFO - https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 15:12:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:12:26 WARNING - URL Error: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:26 INFO - Running command: ['nslookup', u'queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com'] 15:12:26 INFO - Copy/paste: nslookup queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com 15:12:26 INFO - Server: 10.26.75.40 15:12:26 INFO - Address: 10.26.75.40#53 15:12:26 INFO - queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com canonical name = proxxy1.srv.releng.scl3.mozilla.com. 15:12:26 INFO - Name: proxxy1.srv.releng.scl3.mozilla.com 15:12:26 INFO - Address: 10.26.48.46 15:12:26 INFO - Return code: 0 15:12:26 INFO - retry: attempt #1 caught exception: 15:12:26 INFO - retry: Failed, sleeping 30 seconds before retrying 15:12:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #2 15:12:58 INFO - Downloaded 11132144 bytes. 15:12:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:12:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 15:12:58 INFO - Return code: 0 15:12: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')]} 15:12:58 INFO - https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 15:12:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 15:12:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 15:12:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 15:12:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:13:02 INFO - Downloaded 54129190 bytes. 15:13:02 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 15:13:02 INFO - mkdir: /builds/slave/test/properties 15:13:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:13:02 INFO - Writing to file /builds/slave/test/properties/build_url 15:13:02 INFO - Contents: 15:13:02 INFO - build_url:https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 15:13:02 INFO - Running post-action listener: _resource_record_post_action 15:13:02 INFO - Running post-action listener: set_extra_try_arguments 15:13:02 INFO - ##### 15:13:02 INFO - ##### Running populate-webroot step. 15:13:02 INFO - ##### 15:13:02 INFO - Running pre-action listener: _resource_record_pre_action 15:13:02 INFO - Running main action method: populate_webroot 15:13:02 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:13:02 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:13:02 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:13:02 INFO - '--tppagecycles', 15:13:02 INFO - '7'], 15:13:02 INFO - 'tests': ['tsvgm']}}, 15:13:02 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:13:02 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:13:02 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:13:02 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:13:02 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:13:02 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:13:02 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'tests': ['damp', 'tps']}, 15:13:02 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['damp', 'tps']}, 15:13:02 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:13:02 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:13:02 INFO - 'other': {'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'other_l64': {'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'other_nol64': {'tests': ['a11yr', 15:13:02 INFO - 'ts_paint', 15:13:02 INFO - 'tpaint', 15:13:02 INFO - 'sessionrestore', 15:13:02 INFO - 'sessionrestore_no_auto_restore']}, 15:13:02 INFO - 'svgr': {'tests': ['tsvgx', 15:13:02 INFO - 'tsvgr_opacity', 15:13:02 INFO - 'tart', 15:13:02 INFO - 'tscrollx', 15:13:02 INFO - 'cart']}, 15:13:02 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['tsvgx', 15:13:02 INFO - 'tsvgr_opacity', 15:13:02 INFO - 'tart', 15:13:02 INFO - 'tscrollx', 15:13:02 INFO - 'cart']}, 15:13:02 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'tests': ['tp5o']}, 15:13:02 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'talos_options': ['--e10s'], 15:13:02 INFO - 'tests': ['tp5o']}, 15:13:02 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'talos_options': ['--xperf_path', 15:13:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:13:02 INFO - 'tests': ['tp5n']}, 15:13:02 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:13:02 INFO - 'talos_options': ['--e10s', 15:13:02 INFO - '--xperf_path', 15:13:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:13:02 INFO - 'tests': ['tp5n']}}, 15:13:02 INFO - 'talos.zip': {'path': '', 15:13:02 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:13:02 INFO - Running post-action listener: _resource_record_post_action 15:13:02 INFO - ##### 15:13:02 INFO - ##### Running create-virtualenv step. 15:13:02 INFO - ##### 15:13:02 INFO - Running pre-action listener: _resource_record_pre_action 15:13:02 INFO - Running main action method: create_virtualenv 15:13:02 INFO - Creating virtualenv /builds/slave/test/build/venv 15:13:02 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:13:02 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:13:02 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:13:02 INFO - Using real prefix '/usr' 15:13:02 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:13:02 INFO - Installing distribute.............................................................................................................................................................................................done. 15:13:04 INFO - Installing pip.................done. 15:13:04 INFO - Return code: 0 15:13:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:04 INFO - Using env: {'DISPLAY': ':0', 15:13:04 INFO - 'HOME': '/home/cltbld', 15:13:04 INFO - 'LANG': 'en_US.UTF-8', 15:13:04 INFO - 'LANGUAGE': 'en_US:en', 15:13:04 INFO - 'LOGNAME': 'cltbld', 15:13:04 INFO - 'MAIL': '/var/mail/cltbld', 15:13:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:04 INFO - 'MOZ_NO_REMOTE': '1', 15:13:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:04 INFO - 'NO_EM_RESTART': '1', 15:13:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:04 INFO - 'PWD': '/builds/slave/test', 15:13:04 INFO - 'SHELL': '/bin/bash', 15:13:04 INFO - 'SHLVL': '1', 15:13:04 INFO - 'TERM': 'linux', 15:13:04 INFO - 'TMOUT': '86400', 15:13:04 INFO - 'USER': 'cltbld', 15:13:04 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:04 INFO - '_': '/tools/buildbot/bin/python'} 15:13:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:04 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 15:13:04 INFO - Cleaning up... 15:13:04 INFO - Return code: 0 15:13:04 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:04 INFO - Using env: {'DISPLAY': ':0', 15:13:04 INFO - 'HOME': '/home/cltbld', 15:13:04 INFO - 'LANG': 'en_US.UTF-8', 15:13:04 INFO - 'LANGUAGE': 'en_US:en', 15:13:04 INFO - 'LOGNAME': 'cltbld', 15:13:04 INFO - 'MAIL': '/var/mail/cltbld', 15:13:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:04 INFO - 'MOZ_NO_REMOTE': '1', 15:13:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:04 INFO - 'NO_EM_RESTART': '1', 15:13:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:04 INFO - 'PWD': '/builds/slave/test', 15:13:04 INFO - 'SHELL': '/bin/bash', 15:13:04 INFO - 'SHLVL': '1', 15:13:04 INFO - 'TERM': 'linux', 15:13:04 INFO - 'TMOUT': '86400', 15:13:04 INFO - 'USER': 'cltbld', 15:13:04 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:04 INFO - '_': '/tools/buildbot/bin/python'} 15:13:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:05 INFO - Downloading/unpacking psutil>=0.7.1 15:13: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 15:13: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 15:13: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 15:13: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 15:13: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 15:13: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 15:13:06 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 15:13:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 15:13:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:13:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:13:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:13:06 INFO - Installing collected packages: psutil 15:13:06 INFO - Running setup.py install for psutil 15:13:06 INFO - building 'psutil._psutil_linux' extension 15:13:06 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 15:13:07 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 15:13:07 INFO - building 'psutil._psutil_posix' extension 15:13:07 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 15:13:07 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 15:13:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:13:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:13:07 INFO - Successfully installed psutil 15:13:07 INFO - Cleaning up... 15:13:07 INFO - Return code: 0 15:13:07 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:13:07 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')]} 15:13:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:07 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')]} 15:13:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:07 INFO - Using env: {'DISPLAY': ':0', 15:13:07 INFO - 'HOME': '/home/cltbld', 15:13:07 INFO - 'LANG': 'en_US.UTF-8', 15:13:07 INFO - 'LANGUAGE': 'en_US:en', 15:13:07 INFO - 'LOGNAME': 'cltbld', 15:13:07 INFO - 'MAIL': '/var/mail/cltbld', 15:13:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:07 INFO - 'MOZ_NO_REMOTE': '1', 15:13:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:07 INFO - 'NO_EM_RESTART': '1', 15:13:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:07 INFO - 'PWD': '/builds/slave/test', 15:13:07 INFO - 'SHELL': '/bin/bash', 15:13:07 INFO - 'SHLVL': '1', 15:13:07 INFO - 'TERM': 'linux', 15:13:07 INFO - 'TMOUT': '86400', 15:13:07 INFO - 'USER': 'cltbld', 15:13:07 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:07 INFO - '_': '/tools/buildbot/bin/python'} 15:13:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:07 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:13: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 15:13: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 15:13: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 15:13: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 15:13: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 15:13: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 15:13:09 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:13:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 15:13:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:13:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:13:09 INFO - Installing collected packages: mozsystemmonitor 15:13:09 INFO - Running setup.py install for mozsystemmonitor 15:13:09 INFO - Successfully installed mozsystemmonitor 15:13:09 INFO - Cleaning up... 15:13:09 INFO - Return code: 0 15:13:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:13:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:09 INFO - Using env: {'DISPLAY': ':0', 15:13:09 INFO - 'HOME': '/home/cltbld', 15:13:09 INFO - 'LANG': 'en_US.UTF-8', 15:13:09 INFO - 'LANGUAGE': 'en_US:en', 15:13:09 INFO - 'LOGNAME': 'cltbld', 15:13:09 INFO - 'MAIL': '/var/mail/cltbld', 15:13:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:09 INFO - 'MOZ_NO_REMOTE': '1', 15:13:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:09 INFO - 'NO_EM_RESTART': '1', 15:13:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:09 INFO - 'PWD': '/builds/slave/test', 15:13:09 INFO - 'SHELL': '/bin/bash', 15:13:09 INFO - 'SHLVL': '1', 15:13:09 INFO - 'TERM': 'linux', 15:13:09 INFO - 'TMOUT': '86400', 15:13:09 INFO - 'USER': 'cltbld', 15:13:09 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:09 INFO - '_': '/tools/buildbot/bin/python'} 15:13:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:09 INFO - Downloading/unpacking blobuploader==1.2.4 15:13:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:11 INFO - Downloading blobuploader-1.2.4.tar.gz 15:13:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 15:13:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:13:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:13:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 15:13:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:13:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:13:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:13:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:13:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:13:12 INFO - Downloading docopt-0.6.1.tar.gz 15:13:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 15:13:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:13:12 INFO - Installing collected packages: blobuploader, requests, docopt 15:13:12 INFO - Running setup.py install for blobuploader 15:13:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:13:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:13:12 INFO - Running setup.py install for requests 15:13:12 INFO - Running setup.py install for docopt 15:13:12 INFO - Successfully installed blobuploader requests docopt 15:13:12 INFO - Cleaning up... 15:13:12 INFO - Return code: 0 15:13:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:13:12 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')]} 15:13:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:12 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')]} 15:13:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 15:13:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 15:13:12 INFO - Using env: {'DISPLAY': ':0', 15:13:12 INFO - 'HOME': '/home/cltbld', 15:13:12 INFO - 'LANG': 'en_US.UTF-8', 15:13:12 INFO - 'LANGUAGE': 'en_US:en', 15:13:12 INFO - 'LOGNAME': 'cltbld', 15:13:12 INFO - 'MAIL': '/var/mail/cltbld', 15:13:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:12 INFO - 'MOZ_NO_REMOTE': '1', 15:13:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:12 INFO - 'NO_EM_RESTART': '1', 15:13:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:12 INFO - 'PWD': '/builds/slave/test', 15:13:12 INFO - 'SHELL': '/bin/bash', 15:13:12 INFO - 'SHLVL': '1', 15:13:12 INFO - 'TERM': 'linux', 15:13:12 INFO - 'TMOUT': '86400', 15:13:12 INFO - 'USER': 'cltbld', 15:13:12 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:12 INFO - '_': '/tools/buildbot/bin/python'} 15:13:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:13:12 INFO - Running setup.py (path:/tmp/pip-D3eTys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:13:13 INFO - Running setup.py (path:/tmp/pip-mVL5Kw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:13:13 INFO - Running setup.py (path:/tmp/pip-LFQ7A3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:13:13 INFO - Running setup.py (path:/tmp/pip-pH1qpg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:13:13 INFO - Running setup.py (path:/tmp/pip-uIgjGQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:13:13 INFO - Running setup.py (path:/tmp/pip-2IqCU0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:13:13 INFO - Running setup.py (path:/tmp/pip-0xzz99-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:13:13 INFO - Running setup.py (path:/tmp/pip-s4d_u8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:13:13 INFO - Running setup.py (path:/tmp/pip-nzt3aG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:13:13 INFO - Running setup.py (path:/tmp/pip-nmELZ7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:13:13 INFO - Running setup.py (path:/tmp/pip-JFeXxY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:13:13 INFO - Running setup.py (path:/tmp/pip-LnxHhx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:13:13 INFO - Running setup.py (path:/tmp/pip-G2xmMP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:13:13 INFO - Running setup.py (path:/tmp/pip-LfLlo2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:13:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:13:13 INFO - Running setup.py (path:/tmp/pip-Q0WlR2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:13:14 INFO - Running setup.py (path:/tmp/pip-0inJxz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:13:14 INFO - Running setup.py (path:/tmp/pip-hSjHyX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:13:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:13:14 INFO - Running setup.py install for manifestparser 15:13:14 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Running setup.py install for mozcrash 15:13:14 INFO - Running setup.py install for mozdebug 15:13:14 INFO - Running setup.py install for mozdevice 15:13:14 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Running setup.py install for mozfile 15:13:14 INFO - Running setup.py install for mozhttpd 15:13:14 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Running setup.py install for mozinfo 15:13:14 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Running setup.py install for mozInstall 15:13:14 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:13:14 INFO - Running setup.py install for mozleak 15:13:15 INFO - Running setup.py install for mozlog 15:13:15 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Running setup.py install for moznetwork 15:13:15 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Running setup.py install for mozprocess 15:13:15 INFO - Running setup.py install for mozprofile 15:13:15 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Running setup.py install for mozrunner 15:13:15 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Running setup.py install for mozscreenshot 15:13:15 INFO - Running setup.py install for moztest 15:13:15 INFO - Running setup.py install for mozversion 15:13:15 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:13:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:13:15 INFO - Cleaning up... 15:13:15 INFO - Return code: 0 15:13:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:13:15 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')]} 15:13:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:15 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')]} 15:13:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 15:13:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 15:13:15 INFO - Using env: {'DISPLAY': ':0', 15:13:15 INFO - 'HOME': '/home/cltbld', 15:13:15 INFO - 'LANG': 'en_US.UTF-8', 15:13:15 INFO - 'LANGUAGE': 'en_US:en', 15:13:15 INFO - 'LOGNAME': 'cltbld', 15:13:15 INFO - 'MAIL': '/var/mail/cltbld', 15:13:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:15 INFO - 'MOZ_NO_REMOTE': '1', 15:13:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:15 INFO - 'NO_EM_RESTART': '1', 15:13:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:15 INFO - 'PWD': '/builds/slave/test', 15:13:15 INFO - 'SHELL': '/bin/bash', 15:13:15 INFO - 'SHLVL': '1', 15:13:15 INFO - 'TERM': 'linux', 15:13:15 INFO - 'TMOUT': '86400', 15:13:15 INFO - 'USER': 'cltbld', 15:13:15 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:15 INFO - '_': '/tools/buildbot/bin/python'} 15:13:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:13:16 INFO - Running setup.py (path:/tmp/pip-UFW5Ga-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:13:16 INFO - Running setup.py (path:/tmp/pip-qH081O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:13:16 INFO - Running setup.py (path:/tmp/pip-EmnL4i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:13:16 INFO - Running setup.py (path:/tmp/pip-j9hlh6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:13:16 INFO - Running setup.py (path:/tmp/pip-roQP0D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:13:16 INFO - Running setup.py (path:/tmp/pip-LfnEhF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:13:16 INFO - Running setup.py (path:/tmp/pip-RLWVo6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:13:16 INFO - Running setup.py (path:/tmp/pip-3ZNxEd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:13:16 INFO - Running setup.py (path:/tmp/pip-ddRhV7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:13:16 INFO - Running setup.py (path:/tmp/pip-onDbHV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:13:16 INFO - Running setup.py (path:/tmp/pip-YjRBDU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:13:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 15:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:13:16 INFO - Running setup.py (path:/tmp/pip-7_NXFI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 15:13:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:13:17 INFO - Running setup.py (path:/tmp/pip-j2gbp8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 15:13:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:13:17 INFO - Running setup.py (path:/tmp/pip-ruu7vR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 15:13:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:13:17 INFO - Running setup.py (path:/tmp/pip-KAshUq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 15:13:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:13:17 INFO - Running setup.py (path:/tmp/pip-ZTsOyM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 15:13:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:13:17 INFO - Running setup.py (path:/tmp/pip-AfySte-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:13:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:13:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:13:17 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 15:13:17 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 15:13:17 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 15:13:17 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 15:13:17 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 15:13:17 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 15:13:19 INFO - Downloading blessings-1.5.1.tar.gz 15:13:19 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 15:13:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:13:19 INFO - Installing collected packages: blessings 15:13:19 INFO - Running setup.py install for blessings 15:13:19 INFO - Successfully installed blessings 15:13:19 INFO - Cleaning up... 15:13:19 INFO - Return code: 0 15:13:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:13:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:13:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:13:19 INFO - Reading from file tmpfile_stdout 15:13:19 INFO - Current package versions: 15:13:19 INFO - argparse == 1.2.1 15:13:19 INFO - blessings == 1.5.1 15:13:19 INFO - blobuploader == 1.2.4 15:13:19 INFO - docopt == 0.6.1 15:13:19 INFO - manifestparser == 1.1 15:13:19 INFO - mozInstall == 1.12 15:13:19 INFO - mozcrash == 0.16 15:13:19 INFO - mozdebug == 0.1 15:13:19 INFO - mozdevice == 0.48 15:13:19 INFO - mozfile == 1.2 15:13:19 INFO - mozhttpd == 0.7 15:13:19 INFO - mozinfo == 0.9 15:13:19 INFO - mozleak == 0.1 15:13:19 INFO - mozlog == 3.1 15:13:19 INFO - moznetwork == 0.27 15:13:19 INFO - mozprocess == 0.22 15:13:19 INFO - mozprofile == 0.28 15:13:19 INFO - mozrunner == 6.11 15:13:19 INFO - mozscreenshot == 0.1 15:13:19 INFO - mozsystemmonitor == 0.0 15:13:19 INFO - moztest == 0.7 15:13:19 INFO - mozversion == 1.4 15:13:19 INFO - psutil == 3.1.1 15:13:19 INFO - requests == 1.2.3 15:13:19 INFO - wsgiref == 0.1.2 15:13:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:13:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/talos 15:13:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 15:13:19 INFO - Using env: {'DISPLAY': ':0', 15:13:19 INFO - 'HOME': '/home/cltbld', 15:13:19 INFO - 'LANG': 'en_US.UTF-8', 15:13:19 INFO - 'LANGUAGE': 'en_US:en', 15:13:19 INFO - 'LOGNAME': 'cltbld', 15:13:19 INFO - 'MAIL': '/var/mail/cltbld', 15:13:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:19 INFO - 'MOZ_NO_REMOTE': '1', 15:13:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:19 INFO - 'NO_EM_RESTART': '1', 15:13:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:19 INFO - 'PWD': '/builds/slave/test', 15:13:19 INFO - 'SHELL': '/bin/bash', 15:13:19 INFO - 'SHLVL': '1', 15:13:19 INFO - 'TERM': 'linux', 15:13:19 INFO - 'TMOUT': '86400', 15:13:19 INFO - 'USER': 'cltbld', 15:13:19 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:19 INFO - '_': '/tools/buildbot/bin/python'} 15:13:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:13:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 15:13:19 INFO - Cleaning up... 15:13:19 INFO - Return code: 0 15:13:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:13:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:19 INFO - Using env: {'DISPLAY': ':0', 15:13:19 INFO - 'HOME': '/home/cltbld', 15:13:19 INFO - 'LANG': 'en_US.UTF-8', 15:13:19 INFO - 'LANGUAGE': 'en_US:en', 15:13:19 INFO - 'LOGNAME': 'cltbld', 15:13:19 INFO - 'MAIL': '/var/mail/cltbld', 15:13:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:19 INFO - 'MOZ_NO_REMOTE': '1', 15:13:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:19 INFO - 'NO_EM_RESTART': '1', 15:13:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:19 INFO - 'PWD': '/builds/slave/test', 15:13:19 INFO - 'SHELL': '/bin/bash', 15:13:19 INFO - 'SHLVL': '1', 15:13:19 INFO - 'TERM': 'linux', 15:13:19 INFO - 'TMOUT': '86400', 15:13:19 INFO - 'USER': 'cltbld', 15:13:19 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:19 INFO - '_': '/tools/buildbot/bin/python'} 15:13:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:19 INFO - Downloading/unpacking jsonschema 15:13:19 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 15:13:19 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 15:13:19 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 15:13:19 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 15:13:19 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 15:13:19 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 15:13:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:13:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 15:13:21 INFO - Downloading/unpacking functools32 (from jsonschema) 15:13:21 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 15:13:21 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 15:13:21 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 15:13:21 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 15:13:21 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 15:13:21 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 15:13:21 INFO - Downloading functools32-3.2.3-2.tar.gz 15:13:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 15:13:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:13:21 INFO - warning: no files found matching '*.txt' 15:13:21 INFO - no previously-included directories found matching 'build' 15:13:21 INFO - no previously-included directories found matching 'dist' 15:13:21 INFO - no previously-included directories found matching '.git*' 15:13:21 INFO - Installing collected packages: jsonschema, functools32 15:13:22 INFO - Running setup.py install for functools32 15:13:22 INFO - warning: no files found matching '*.txt' 15:13:22 INFO - no previously-included directories found matching 'build' 15:13:22 INFO - no previously-included directories found matching 'dist' 15:13:22 INFO - no previously-included directories found matching '.git*' 15:13:22 INFO - Successfully installed jsonschema functools32 15:13:22 INFO - Cleaning up... 15:13:22 INFO - Return code: 0 15:13:22 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 15:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:13:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:13:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:13:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06b0b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad5dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 15:13:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 15:13:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:13:22 INFO - Using env: {'DISPLAY': ':0', 15:13:22 INFO - 'HOME': '/home/cltbld', 15:13:22 INFO - 'LANG': 'en_US.UTF-8', 15:13:22 INFO - 'LANGUAGE': 'en_US:en', 15:13:22 INFO - 'LOGNAME': 'cltbld', 15:13:22 INFO - 'MAIL': '/var/mail/cltbld', 15:13:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:22 INFO - 'MOZ_NO_REMOTE': '1', 15:13:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:22 INFO - 'NO_EM_RESTART': '1', 15:13:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:22 INFO - 'PWD': '/builds/slave/test', 15:13:22 INFO - 'SHELL': '/bin/bash', 15:13:22 INFO - 'SHLVL': '1', 15:13:22 INFO - 'TERM': 'linux', 15:13:22 INFO - 'TMOUT': '86400', 15:13:22 INFO - 'USER': 'cltbld', 15:13:22 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:22 INFO - '_': '/tools/buildbot/bin/python'} 15:13:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:13:22 INFO - Downloading/unpacking flake8 15:13:22 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 15:13:22 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 15:13:22 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 15:13:22 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 15:13:22 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 15:13:22 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 15:13:24 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 15:13:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 15:13:24 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 15:13:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 15:13:24 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 15:13:24 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 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 15:13:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 15:13:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 15:13:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:13:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:13:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:13:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:13:24 INFO - no previously-included directories found matching 'docs/_build' 15:13:24 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 15:13:24 INFO - Running setup.py install for pep8 15:13:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:13:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:13:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:13:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:13:24 INFO - no previously-included directories found matching 'docs/_build' 15:13:24 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 15:13:24 INFO - Successfully installed flake8 mccabe pyflakes pep8 15:13:24 INFO - Cleaning up... 15:13:24 INFO - Return code: 0 15:13:24 INFO - Running post-action listener: _resource_record_post_action 15:13:24 INFO - Running post-action listener: _start_resource_monitoring 15:13:24 INFO - Starting resource monitoring. 15:13:24 INFO - ##### 15:13:24 INFO - ##### Running install step. 15:13:24 INFO - ##### 15:13:24 INFO - Running pre-action listener: _resource_record_pre_action 15:13:24 INFO - Running main action method: install 15:13:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:13:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:13:25 INFO - Reading from file tmpfile_stdout 15:13:25 INFO - Detecting whether we're running mozinstall >=1.0... 15:13:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:13:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:13:25 INFO - Reading from file tmpfile_stdout 15:13:25 INFO - Output received: 15:13:25 INFO - Usage: mozinstall [options] installer 15:13:25 INFO - Options: 15:13:25 INFO - -h, --help show this help message and exit 15:13:25 INFO - -d DEST, --destination=DEST 15:13:25 INFO - Directory to install application into. [default: 15:13:25 INFO - "/builds/slave/test"] 15:13:25 INFO - --app=APP Application being installed. [default: firefox] 15:13:25 INFO - mkdir: /builds/slave/test/build/application 15:13:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:13:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:13:41 INFO - Reading from file tmpfile_stdout 15:13:41 INFO - Output received: 15:13:41 INFO - /builds/slave/test/build/application/firefox/firefox 15:13:41 INFO - Running post-action listener: _resource_record_post_action 15:13:41 INFO - ##### 15:13:41 INFO - ##### Running run-tests step. 15:13:41 INFO - ##### 15:13:41 INFO - Running pre-action listener: _resource_record_pre_action 15:13:41 INFO - Running main action method: run_tests 15:13:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:13:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:13:41 INFO - Python 2.7.3 15:13:41 INFO - Return code: 0 15:13:41 INFO - grabbing minidump binary from tooltool 15:13:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:13:41 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/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 0x2b683d0>, '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 0x2ad3ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:13:41 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 15:13:41 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 15:13:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:13:41 INFO - Return code: 0 15:13:41 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:13:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:13:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:13:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:13:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:13:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 15:13:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 15:13:42 INFO - Return code: 0 15:13:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 15:13:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-036 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 15:13:42 INFO - Using env: {'DISPLAY': ':0', 15:13:42 INFO - 'HOME': '/home/cltbld', 15:13:42 INFO - 'LANG': 'en_US.UTF-8', 15:13:42 INFO - 'LANGUAGE': 'en_US:en', 15:13:42 INFO - 'LOGNAME': 'cltbld', 15:13:42 INFO - 'MAIL': '/var/mail/cltbld', 15:13:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:13:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:13:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:13:42 INFO - 'MOZ_NO_REMOTE': '1', 15:13:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:13:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:13:42 INFO - 'NO_EM_RESTART': '1', 15:13:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:13:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:13:42 INFO - 'PWD': '/builds/slave/test', 15:13:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:13:42 INFO - 'SHELL': '/bin/bash', 15:13:42 INFO - 'SHLVL': '1', 15:13:42 INFO - 'TERM': 'linux', 15:13:42 INFO - 'TMOUT': '86400', 15:13:42 INFO - 'USER': 'cltbld', 15:13:42 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904', 15:13:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:13:42 INFO - '_': '/tools/buildbot/bin/python'} 15:13:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 15:13:42 INFO - mozversion application_buildid: 20160116142922 15:13:42 INFO - mozversion application_changeset: c539267331fb152e9d196cf2bedbd0184c71afb8 15:13:42 INFO - mozversion application_display_name: Nightly 15:13:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:13:42 INFO - mozversion application_name: Firefox 15:13:42 INFO - mozversion application_remotingname: firefox 15:13:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 15:13:42 INFO - mozversion application_vendor: Mozilla 15:13:42 INFO - mozversion application_version: 46.0a1 15:13:42 INFO - mozversion platform_buildid: 20160116142922 15:13:42 INFO - mozversion platform_changeset: c539267331fb152e9d196cf2bedbd0184c71afb8 15:13:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 15:13:42 INFO - mozversion platform_version: 46.0a1 15:13:42 INFO - using testdate: 1452986022 15:13:42 INFO - actual date: 1452986022 15:13:42 INFO - starting webserver on 'localhost:41498' 15:13:42 INFO - SUITE-START | Running 3 tests 15:13:42 INFO - TEST-START | dromaeo_css 15:13:42 INFO - operating with platform_type : linux_ 15:13:42 INFO - Initialising browser for dromaeo_css test... 15:13:42 INFO - TEST-INFO | started process 15478 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1r0JFU/profile http://localhost:41498/getInfo.html) 15:13:47 INFO - PROCESS | 15478 | __metrics Screen width/height:1600/1200 15:13:47 INFO - PROCESS | 15478 | colorDepth:24 15:13:47 INFO - PROCESS | 15478 | Browser inner width/height: 1024/697 15:13:47 INFO - PROCESS | 15478 | __metrics 15:13:47 INFO - PROCESS | 15478 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 15:13:47 INFO - PROCESS | 15478 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:13:48 INFO - TEST-INFO | 15478: exit 0 15:13:48 INFO - Browser initialized. 15:13:48 INFO - Running cycle 1/1 for dromaeo_css test... 15:13:48 INFO - TEST-INFO | started process 15571 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1r0JFU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:14:00 INFO - PROCESS | 15571 | RSS: Main: 150794240 15:14:00 INFO - PROCESS | 15571 | 15:14:51 INFO - PROCESS | 15571 | 1452986091058 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] 15:17:02 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41498/tests/dromaeo/cssquery-ext.html) 15:17:03 INFO - PROCESS | 15571 | RSS: Main: 255193088 15:17:03 INFO - PROCESS | 15571 | 15:20:05 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-ext.html (next: http://localhost:41498/tests/dromaeo/cssquery-jquery.html) 15:20:06 INFO - PROCESS | 15571 | RSS: Main: 230604800 15:20:06 INFO - PROCESS | 15571 | 15:23:08 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41498/tests/dromaeo/cssquery-mootools.html) 15:23:09 INFO - PROCESS | 15571 | RSS: Main: 225431552 15:23:09 INFO - PROCESS | 15571 | 15:26:11 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41498/tests/dromaeo/cssquery-prototype.html) 15:26:11 INFO - PROCESS | 15571 | RSS: Main: 211517440 15:26:11 INFO - PROCESS | 15571 | 15:29:14 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41498/tests/dromaeo/cssquery-yui.html) 15:29:15 INFO - PROCESS | 15571 | RSS: Main: 213712896 15:29:15 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | Cycle 1(1): loaded http://localhost:41498/tests/dromaeo/cssquery-yui.html (next: http://localhost:41498/tests/dromaeo/cssquery-dojo.html) 15:32:17 INFO - PROCESS | 15571 | RSS: Main: 228376576 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | __start_tp_report 15:32:17 INFO - PROCESS | 15571 | _x_x_mozilla_page_load 15:32:17 INFO - PROCESS | 15571 | _x_x_mozilla_page_load_details 15:32:17 INFO - PROCESS | 15571 | |i|pagename|runs| 15:32:17 INFO - PROCESS | 15571 | |0;dojo.html;2586.7413258674137;2609.2433194373634;2628.158989123481;2645.3915599412135;2661.9600705989405;4275.44419225501;4367.7160984535985;4375.7155784874;4389.880580451984;4415.271480205766;4372.8469503567385;4373.890652733683;4376.912461750763;4410.051838854645;4448.888777780557;4015.8996025099314;4018.658414034796;4052.2705912935658;4087.4073259377374;4121.402396652484;3950.3679411294197;4013.4581831452674;4099.815508302118;4100.302948498747;4118.6499147572495;3976.065624578222;4017.3973903914352;4030.5364883038533;4053.1083161704673;4068.2677118118727;4030.717849750519;4058.79706014701;4079.9592004079877;4086.2849001424634;4113.588641135892;3924.1563063941103;3994;4024.1549274652066;4026.295398305285;4051;4342.283523218665;4345.1961387143165;4352.303631418958;4369.43197384338;4391.319345501421;4626.676132670715;4627.629789616823;4628.629709623222;4642.79107440166;4659.370984917026;4517.412736344287;4613.261878099522;4640.605548528345;4655.7439340836245;4700.247960326331;4303.35449682547;4341.45731783527;4392.758398288125;4419.558044195554;4437.733735975852;4778.04439112172;4808.951910480921;4810;4810.63920205986;4853.975730121327;4496.617787488035;4569.451665800125;4614.584687378152;4623.514530974199;4627.629789616823;4608.792604332746;4665.766711664403;4699.85900422981;4718.740469274154;4765.594924431392;4613.861584152481;4624.815007399667;4629.328747331618;4632.305154226893;4665.906681866344;4495.88760280989;4583.2666773316105;4624.28323609841;4625.722456652612;4656.557627025427;3902.863399780994;3925.2345792570177;3984.5816189300285;3999.440078389028;4021.3766866135797;3500.212452198235;3504.3341765064556;3509.508668786372;3541.8760343387858;3551.786892786441;3980.24375368679;4048.574899635496;4050.25070361984;4066.268071747055;4100.938485922714;4626.930596041062;4630.143423466669;4657.371254880548;4692.483826779052;4697.812087516461;3953.2093581283857;4003.5195776507007;4005.4792876925812;4015.7188996769946;4030.6573941215324;4137.338025915899;4146.232946904832;4147.771872547039;4148.377743338523;4172.520160181557;4388.144311859221;4437.1125774845805;4472.44094488189;4475.641948644101;4508.45898492183;4597.149527337453;4615.376924115201;4620.3993480847275;4631.51369106239;4658.37111989877;4396.1867054595;4427.601515863587;4428.269335559726;4428.446444194476;4461.330800379969;4512.5261847505535;4588.403507544132;4589.151007063704;4593.678442509126;4673;4636.304554316879;4646.628269738345;4655.534446555317;4668.789904454376;4691.788869500812;4512.774361281857;4522.366868638327;4522.773861306856;4529.343245229489;4563.429571303587;4411.426514553087;4468.530804265635;4480.574345437179;4481.619062379734;4567.109413664303;4430.955690443183;4441.267190913463;4445.622122119656;4451.777411129366;4462.888427789331;4541.500434952087;4545.363649089064;4551.499335073073;4594.47163576193;4601.769911504478;4330.17726631939;4407.779611019372;4409.294512877924;4436.223660859401;4496.550344965477 15:32:17 INFO - PROCESS | 15571 | |1;ext.html;494.8614387971367;501.50601657367486;519.2263527344257;522.2844702757218;545.5090418623239;24596.631050534234;25078.87460562697;32444.837775811146;32794.50808237879;32809.34381312372;35692.2861542769;35969.280614387695;36002.63997360026;36039.459408108836;36204;7689.961550192255;7882.172371900954;7885.645145968445;7895.368370530373;7898.842023159534;7579.355754760852;7653.349465295457;7678.117016543113;7692.692292308301;7693.846123077535;7868.763937081897;7919.802004949894;7924.326432253265;7939.880901786478;7944.920550794476;7832.647530861096;7840.960795196044;7852.528848269122;7867.134615192324;7875.921240787576;7752.844943101107;7919.52482851025;7929.563873986928;7930.762077137695;7934.801629959239;35894.82052589746;36115.638843611494;36336.09159771027;36345.63654363449;36397.45403818945;3012.9849350753107;3022.6221722284713;3314.648060906039;3603.621619729917;3621.4205727083804;27318.45363092747;27364;27508.44983100327;27616.171514854588;28187.43625127486;3352.279259959096;3388.745844061705;3389.2882494676146;3400.302937897725;3439.5872495300723;155343;155584.22207888888;156122;156269;156369.99999999886;46251.5374846254;47443.5255647446;52645.7367713159;53083.73458132685;53106.73446632742;40329.39505907414;58484.70757646269;59148.40851591429;59440;59540;12094.455749491293;12165.148439609142;12259.816102758467;12262.448189831479;12284.815727764091;9970.102690757722;10080.647177348757;10086.142677872316;10097.192224622013;10103.797924041479;15992;16406;18566.628667426576;19114.904425477784;19122.139503722366;6537.542372033912;6791.388775010174;6814.705206010842;6823.624700641413;6914.481413893978;774.3959711425098;797.696875187425;902.4855832175597;947.9478628675352;983.7287293503913;24197.395065123514;24204;24235.878820606136;24252.514949700908;24253.51492970166;876.7063033883593;879.8180512329459;906.664534122379;938.441627231796;942.8067246214509;13501.324933753272;13643.317834108453;13745.931270343584;14245.216513091673;14374;207751;210730;211335;211647;211903;43980;44945.55054449479;44978.775106124915;45070.32394514085;45086;1045.320541647935;1072.8551645528066;1082.107261509258;1145.7364806094645;1152.7809716153904;25371;26235;27914.860425698553;28555.42889142247;28678.56982145311;39251.803740981115;39486.80256598699;39522.64057555025;39533;39624.207515850096;197937.02062979763;220213;224118;225966;234864;24707.752922470547;24727.62908556409;24768.76156192147;24817.875910620332;25038.248852534452;33612.495812562345;35678.4648230282;37899;38310;38724.2255154901;29824.36849628603;32424;32849.50725739163;33232.501512477815;33429.83285083559;30130.84934575313;30139.547906780976;31175.532367014966;31259;31800;28361.14916552507;28633.42733145367;28695.13914582566;28727.281817954718;28798.7120128796;26240.475190496465;27015.324616884736;28932;29125.271868203465;29169.270768230963;22535.774642253367;22536.715354328822;22568.758718270652;22592.5481490366;22644.433889152904 15:32:17 INFO - PROCESS | 15571 | |2;jquery.html;332.47800952504565;332.8801631412692;334.04130146479605;336.5389416499398;343.5482340721949;13957;14445.855541444582;14878.851211487896;15528.378864845392;15539.14534700591;9122.315826313037;13589.660258493543;13655.385507652154;14048.438062477515;14216;3420.2304481491715;4398.164348773731;4536.455625324966;4546.431696037996;4546.704464209833;3500.632433594474;4785.808567657307;4969.4036715594175;4974.87562810929;4980;4794.568488836004;4945.62907781916;4970.428400733926;4970.527799859007;4989.476105008976;3387.8475468603974;3489.9127521812156;4899.240617704261;4939.67892087015;4956.900861982776;4911.386076740408;4913.238448040559;4934.185859333205;4935.6545041847085;4937.210046392596;12168.756624867454;17357.305707771673;18029.7295540567;18056.27774889003;18126.818731812644;1582.6359937214504;1588.4916826615488;1654.5119189839027;1720.8795384323103;1738.5219064757166;7749;7900.762977110696;7926.564038977912;8013.51918884863;10095.444750538718;1663.6340005198838;1671.122660603181;1686.6795308891394;1701.9404320848712;1726.8186840381704;42038.57961420408;42967;43393.56606433927;43734;47472.28791568129;9280.7679808004;9459.858102128474;9491.477968711788;9502.144806967406;9657.46883921391;11674.591389301333;11714.70713232176;11783.528658853722;11803.23278986863;11828;6481.384268494486;6619.470442364599;6632.1709786276715;6678.198616165994;6732.663366831639;6195.349488303754;6211.192544969125;6243;6364.968175159094;6380;4020.0954785173103;4025.879223623296;4075.7146999709735;4089.407035979766;4144.295469770146;1542.3830467812966;1646.7118254305449;1707.1464267866068;1732.826717328257;1753.7106377447833;333.08900158067667;335.2741315052932;360.6591770776591;682.1302838880368;770.9151993280734;7781.649825757854;8251.463654862415;8718.215360617574;9624.615015399306;9869.950650246847;322.60964233277525;354.39575523731975;358.9784612923233;371.55970175342304;384.5750445757454;4694.647901407408;5260.105782017066;5271.182966640177;5283.392409872837;5336.306280183629;442214;445751;448971;453200.7339963279;454385;57345.426545734845;58677.41322586805;59380.406195938354;59788.402115978286;60534.39465605376;400.37941191153595;405.8559211479882;406.0093372171891;406.5000049938592;407.06984540325215;9000.50497222659;9106.317026223192;9169.35814492979;9177.311701622271;9243.722688319092;29272.975445859294;29406.558901616067;29432.11703648894;29676.70323296826;30513.23716907095;36205.81897090603;36528.26943461169;37607.43588846115;37804.24391512099;38356.42465363078;6007.339192688888;6167.84580385494;6170.321264660974;6193.071039343954;6335.936640633719;6969.756058537927;9011.684591039282;9480.194183494481;9509.809803804024;9536;8209.71266005687;8326.333893288644;8580.313574913867;8760.605772740115;8765.474071555727;6176.969115154396;8018;8303.95848020756;8311.210435008665;8400.117987611213;8354.45696029756;8400.453970491899;8648.567571621268;8844.425112367675;8858.291336693179;5930.970345148246;6284.277308109626;6291.748330066929;6410.487161027013;6616.437602803816;6816.693248803716;8309.6676132954;8323.375746819134;8415.621297041525;8450.704225352083 15:32:17 INFO - PROCESS | 15571 | |3;mootools.html;1241.9751604967907;1374.4708287309386;1374.5326588959751;1477.2392218007728;1683.5706894741847;5664.433556644339;6386.840328991778;6540.574862633932;6552.967235163829;6685;6355.586886852363;6494.5453818232745;6505.056766768816;6517.902231466532;6556.6066036037755;1680.4286542575521;1714.6999275126802;1716.9055701936388;1964.6070785842853;1991.4822146242009;1738.0006496264634;1746.4935168801032;1936.7966363531837;1969.7242386065961;1972.5956178983274;1965.8329042031444;1966.7934866838991;1969.901504924748;1970.7142464342662;1971.8028197180238;1893.2521653946683;1957.716131160988;1958.9804101958941;1961.4213806926991;1961.7842037375876;1921.769387673474;1945.1441365799144;1950.161430584848;1952.8144826241485;1962.9988705760022;6819.795406137824;6900.2064762551945;6911.827204319882;6913.20498142715;6929.99515070317;3884.747491413049;3998.260321840469;3999.960000399988;4000.719949603529;4006.4991876015497;2468.2101727447225;2474.4556197636493;2515.72327044025;2529.9747002530107;2636.657234559514;829.4732844643635;832.8251067275879;1684.7304431290934;1696.9830301696948;1697.4737831272346;8607.827843443096;8677.045524992245;8683.696070637561;8729.345299102593;8746.125387461267;3338.2655815720505;3383.120388698907;3439.7764145330475;3440.82795860206;3441.8451169697423;7138.892916606255;7180.640967951582;7187.029750983655;7199.820004499929;7208.062951816335;3912.902177445587;3925.1168487090176;3929.5677475478246;3937.074787424953;3944.7041471889725;3618.2401695644207;3628.0748409155494;3637.1089083174793;3647.361711700442;3669.743117981769;2891.9421611568073;2912.7815413844046;2949.2626843289177;2956.1870485616196;2958.7485063769823;811.6834434570522;831.1563762780783;872.4895935877456;897.537768049455;909.1408618855119;1098.181854518389;1103.9613613523488;1104.3815463340554;1119.731264496515;1138.3113216504062;5943.613665111754;5963.0459126539545;5965.880682386415;5975.850603734942;5979.910301345483;927.9536023198813;943.4669411782459;950.8954015058338;951.4957072751453;972.4845831709206;4966.453690094087;5014.448410674823;5018.197088465901;5018.648694591344;5035.169197082514;7606.087269527692;7812.687492500237;7858.724944627025;8107.959460202661;8187.222213889671;7873.448858579844;8015.919840801634;8026.959865200637;8028.4781489203015;8064.032316121986;6250.593711408744;6290.909991824214;6349.52378571609;6382.936170638234;6385.968070159713;5939.970300148471;6060.939390606038;6063.514918806397;6065.059915713072;6070.3019152798;7019.508634395544;7100.502964792415;7167.784966451015;7210.4231661468;7233;6957;7083.645817708991;7127.893081603676;7159.821004474929;7215.891761623475;5896.764129434775;5999.880002400015;6004.489618382487;6010.098485227251;6015.969920150371;6303.432691057827;6336.08126821599;6353.841153971188;6384.776532821329;6408.038794180724;4977.726225057657;6155.507559395327;6219.191505104308;6282.403171698681;6289.654069026247;5817.447342502455;5832.679202643895;5908.113782932594;5912.645241285537;5963.105534169909;6086;6122.5408094392205;6124.724387402489;6127.938720612737;6137.815865524041;5457.645253058538;5640.605157638925;5642.2665053544415;5643;5652.971735141298;5426.864328391822;5464.617476776746;5489.560835133259;5494.780208791603;5497.5601951842955 15:32:17 INFO - PROCESS | 15571 | |4;prototype.html;273.64409351662516;277.57808131639894;278.9414223013167;280.59874379637125;281.27711780723547;5050.823221187259;5081.1108056090125;5233.293505376773;5291.603129765269;5301.125314323137;5098.923516147261;5258.2638430619745;5271.710055946931;5274.973625131878;5275.683458992454;4032.9395059074063;4040.131371755072;4040.1919616076757;4048.4534587830562;4053.3312003519386;3798.9810050949704;3881.8835434936996;4037.5962403759536;4040.1717647882115;4042.898927526806;3842.4812650292133;3842.9615703842883;3884.242572698325;3908.9609103909024;3994.2211268802594;4005;4005.639492445694;4008.97995510022;4015.0765323975647;4026.2752704513177;3488.843002064888;3489.5289135966573;3495.790252584853;3495.8951231463097;3496.7552271341015;5062.797488100471;5075.543201111917;5082.059818933509;5086.364204474441;5087.338645976037;4482.820687172509;4591.770411479412;4593.816247350102;4595.379623750784;4597.563231493003;5489.286392768954;5491.533219676332;5500.80747173847;5503.889922201573;5510.448955104497;3544.5746510418658;3614.8915532534065;3796.4115562087923;3797.1646237827636;3800.3349413852466;5607.8878422431735;5753.7123143843055;5777.613372790542;5780.624259423124;5787.074068149076;3916.941245881314;3919.470871432377;3920.09837737322;3921.647051765298;3925.862594809225;3964.960350396459;3970.5235371754998;3976.065624578222;3977.6817854571564;3979.840806367713;4417.491988421309;4572.268437050123;4582.95417045832;4583.770811459413;4589.426321709786;5484.012877682056;5489.149181876815;5489.945100549024;5491.670499770026;5494;1385.1135273425016;1402.978955315671;1403.1230480949407;1403.6561042544643;1405.1709491399918;938.9483578403117;948.9288303377274;949.2074118111454;963.4893506441597;966.4442945306477;4848.272759086095;4851.078295123915;4853.3447984522345;4865.1485989952325;4865.294532292798;5735.627184233012;5739.827805165852;5743;5745.540356771448;5746.396628354046;4785.95214047862;4807.086653535817;4826.348442960226;4829.710217386968;4832;2994.1017694691504;3047.1467988963127;3051.5117581187346;3076.077176846937;3078.5382192671277;5424.403315635277;5440.564754819605;5443.156310771837;5444.537214336747;5449.04641687703;5818.679972601548;5856.502197313191;5859.150423188614;5860.384659610765;5865.472107510259;5431.728413579305;5433.673979561239;5435.809746658848;5442.91835622466;5444.047291723932;5570.753298731775;5653.180288858175;5692.516136128475;5704.401037890962;5710.2576665033275;5367.490088441592;5586;5588.580856435702;5593.720313984366;5594.300712410949;5301.204819277139;5362.65142765719;5448;5481.561475082063;5491.588130890119;3864.594217607223;3884.708646851441;3888.5722570517787;3892.163184915257;3895.3183192941688;5712.5429965601825;5740.052891272893;5748.885022299614;5757.884842303047;5766.855828604151;5390.487903649304;5522.641028333145;5544.7782088716;5556.583256255716;5563.554915606823;5522.420145884625;5540.252065971204;5548.528375088163;5558;5566.693831839126;5419.34967803866;5422.56302079957;5422.810201642924;5432.837014889559;5435.048866448276;5363.168708850135;5591.804286849941;5600.663960162403;5601.215829783752;5606.747696353756;5347.278117454094;5353.2505449237915;5356.812511562077;5360.490753378423;5362.51737343641 15:32:17 INFO - PROCESS | 15571 | |5;yui.html;664.4285914113863;747.0885519666006;760.9277118673725;774.938004959603;802.2939812964594;11110.666679999593;11224.887751122507;11236.269642473233;11252.718682032953;11283.153763467742;10186.28695991281;10599.417032063233;10970.232083754141;11076.667699968993;11087.33475991441;731.8609464201811;747.7980945144808;748.4124961904906;748.648135376375;748.8464864702723;749.35181068376;752.1613401057808;752.3567349915825;752.3717695724077;752.9397648188132;778.3384123495013;778.8831675248701;781.5467029123123;782.7377828427456;783.3576467296818;766.2682138557664;769.3575864153438;774.314731462654;775.042822114688;779.2441331908041;576.6799426318391;576.8644368573382;576.890390825746;577.2899333819383;578.806099956515;9788.168005719523;9874.90125098747;9875.209983201326;9897.851532227023;9899.406035637812;9729.756756081084;9907.752306192331;9989.450580218085;10008.09927106564;10129.594816207416;10532.315399499084;10679.733006674818;10724.142068634568;10872.238943273975;11026.44867756609;3941.4284928685465;3950.071733142709;3953.1303113315025;3954.62431069048;3955.1496428267774;35040.64959350399;35787.421257874004;40507.18985620271;44179.55820441819;44542.777286113684;9487.810243795224;9538.713838584854;9558.522073896278;9562.56968436422;9583.568739406743;15716.449924252596;15719.371225150866;15719.68560628804;15727.213639317988;15754.527364178864;6056.697165141725;6191.907121393183;6314.810555683337;6430.3891130342545;6560.540762146699;3608.693261072838;3654.488371627974;3661.7436779425716;3685.760425572329;3743.3074881147077;2620.9868950655123;2625.133705877056;2647.2984659065364;2653.946921061568;2655.8937642494084;478.289739736491;482.151413512214;482.62355362816356;489.96570240082855;491.13069866336383;483.47228207834087;514.7477735909378;526.4051621667568;526.631358049367;531.4074806590701;7007.894881576781;7130;7900.170482099296;7964.20357964199;8417.621207045575;450.4414525987752;452.14544510874475;531.2350215689395;531.6969327483374;546.6829239041347;3359.277755282626;3491.8952431427097;3567.7324200684534;3585.1395665040204;3639.2721455708966;43477.13045739131;44064.339034914505;44287;44298.11403771971;44311.55688443139;36923.26153476969;38345.233095337935;40501.594984050374;41469.37795933063;41718.79140604338;37234.25531489355;42007.15985680269;42065.369019464124;43458.34812477815;43643.78178109089;7374.594397308199;7694.499857509244;7726.9227307726205;7774.067111946602;7782.301859281796;27994.300142496602;29138;30355;30528.542071869382;30773.384532309676;34961;35149.64850351464;35358.292834143685;37256.81371593233;37361.62638373581;9593.328467007243;9612.557122988223;9739.610415583298;9745.756356091155;9889.703308900744;10322.329048611817;10343.534540945826;10398.844017339594;10418.479076046016;10655;9823.21414286841;10032.147267482054;10062.597496100074;10077.899221007696;10095.444750538498;10112;10129;10133.442660653734;10135.7466063349;10154.492275386054;9716.562754675915;9812.607495700378;9821.950890245504;9828;9883.456409897237;8131.634076466691;8364;8414;8421.452605580862;8422.70520531803;8196.385271104571;8562.186592273723;8696.521691307038;8780.385373023826;8797.604107815036 15:32:17 INFO - PROCESS | 15571 | __end_tp_report 15:32:17 INFO - PROCESS | 15571 | __start_cc_report 15:32:17 INFO - PROCESS | 15571 | _x_x_mozilla_cycle_collect,896 15:32:17 INFO - PROCESS | 15571 | __end_cc_report 15:32:17 INFO - PROCESS | 15571 | __startTimestamp1452987137942__endTimestamp 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | ------- Summary: start ------- 15:32:17 INFO - PROCESS | 15571 | Number of tests: 6 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#0] dojo.html Cycles:165 Average:4317.73 Median:4430.96 stddev:416.20 (9.4%) stddev-sans-first:394.71 15:32:17 INFO - PROCESS | 15571 | Values: 2586.7 2609.2 2628.2 2645.4 2662.0 4275.4 4367.7 4375.7 4389.9 4415.3 4372.8 4373.9 4376.9 4410.1 4448.9 4015.9 4018.7 4052.3 4087.4 4121.4 3950.4 4013.5 4099.8 4100.3 4118.6 3976.1 4017.4 4030.5 4053.1 4068.3 4030.7 4058.8 4080.0 4086.3 4113.6 3924.2 3994.0 4024.2 4026.3 4051.0 4342.3 4345.2 4352.3 4369.4 4391.3 4626.7 4627.6 4628.6 4642.8 4659.4 4517.4 4613.3 4640.6 4655.7 4700.2 4303.4 4341.5 4392.8 4419.6 4437.7 4778.0 4809.0 4810.0 4810.6 4854.0 4496.6 4569.5 4614.6 4623.5 4627.6 4608.8 4665.8 4699.9 4718.7 4765.6 4613.9 4624.8 4629.3 4632.3 4665.9 4495.9 4583.3 4624.3 4625.7 4656.6 3902.9 3925.2 3984.6 3999.4 4021.4 3500.2 3504.3 3509.5 3541.9 3551.8 3980.2 4048.6 4050.3 4066.3 4100.9 4626.9 4630.1 4657.4 4692.5 4697.8 3953.2 4003.5 4005.5 4015.7 4030.7 4137.3 4146.2 4147.8 4148.4 4172.5 4388.1 4437.1 4472.4 4475.6 4508.5 4597.1 4615.4 4620.4 4631.5 4658.4 4396.2 4427.6 4428.3 4428.4 4461.3 4512.5 4588.4 4589.2 4593.7 4673.0 4636.3 4646.6 4655.5 4668.8 4691.8 4512.8 4522.4 4522.8 4529.3 4563.4 4411.4 4468.5 4480.6 4481.6 4567.1 4431.0 4441.3 4445.6 4451.8 4462.9 4541.5 4545.4 4551.5 4594.5 4601.8 4330.2 4407.8 4409.3 4436.2 4496.6 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#1] ext.html Cycles:180 Average:35351.69 Median:33331.17 stddev:51411.70 (154.2%) stddev-sans-first:51489.30 15:32:17 INFO - PROCESS | 15571 | Values: 494.9 501.5 519.2 522.3 545.5 24596.6 25078.9 32444.8 32794.5 32809.3 35692.3 35969.3 36002.6 36039.5 36204.0 7690.0 7882.2 7885.6 7895.4 7898.8 7579.4 7653.3 7678.1 7692.7 7693.8 7868.8 7919.8 7924.3 7939.9 7944.9 7832.6 7841.0 7852.5 7867.1 7875.9 7752.8 7919.5 7929.6 7930.8 7934.8 35894.8 36115.6 36336.1 36345.6 36397.5 3013.0 3022.6 3314.6 3603.6 3621.4 27318.5 27364.0 27508.4 27616.2 28187.4 3352.3 3388.7 3389.3 3400.3 3439.6 155343.0 155584.2 156122.0 156269.0 156370.0 46251.5 47443.5 52645.7 53083.7 53106.7 40329.4 58484.7 59148.4 59440.0 59540.0 12094.5 12165.1 12259.8 12262.4 12284.8 9970.1 10080.6 10086.1 10097.2 10103.8 15992.0 16406.0 18566.6 19114.9 19122.1 6537.5 6791.4 6814.7 6823.6 6914.5 774.4 797.7 902.5 947.9 983.7 24197.4 24204.0 24235.9 24252.5 24253.5 876.7 879.8 906.7 938.4 942.8 13501.3 13643.3 13745.9 14245.2 14374.0 207751.0 210730.0 211335.0 211647.0 211903.0 43980.0 44945.6 44978.8 45070.3 45086.0 1045.3 1072.9 1082.1 1145.7 1152.8 25371.0 26235.0 27914.9 28555.4 28678.6 39251.8 39486.8 39522.6 39533.0 39624.2 197937.0 220213.0 224118.0 225966.0 234864.0 24707.8 24727.6 24768.8 24817.9 25038.2 33612.5 35678.5 37899.0 38310.0 38724.2 29824.4 32424.0 32849.5 33232.5 33429.8 30130.8 30139.5 31175.5 31259.0 31800.0 28361.1 28633.4 28695.1 28727.3 28798.7 26240.5 27015.3 28932.0 29125.3 29169.3 22535.8 22536.7 22568.8 22592.5 22644.4 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#2] jquery.html Cycles:180 Average:22704.80 Median:4912.31 stddev:73328.19 (1492.7%) stddev-sans-first:73514.65 15:32:17 INFO - PROCESS | 15571 | Values: 332.5 332.9 334.0 336.5 343.5 13957.0 14445.9 14878.9 15528.4 15539.1 9122.3 13589.7 13655.4 14048.4 14216.0 3420.2 4398.2 4536.5 4546.4 4546.7 3500.6 4785.8 4969.4 4974.9 4980.0 4794.6 4945.6 4970.4 4970.5 4989.5 3387.8 3489.9 4899.2 4939.7 4956.9 4911.4 4913.2 4934.2 4935.7 4937.2 12168.8 17357.3 18029.7 18056.3 18126.8 1582.6 1588.5 1654.5 1720.9 1738.5 7749.0 7900.8 7926.6 8013.5 10095.4 1663.6 1671.1 1686.7 1701.9 1726.8 42038.6 42967.0 43393.6 43734.0 47472.3 9280.8 9459.9 9491.5 9502.1 9657.5 11674.6 11714.7 11783.5 11803.2 11828.0 6481.4 6619.5 6632.2 6678.2 6732.7 6195.3 6211.2 6243.0 6365.0 6380.0 4020.1 4025.9 4075.7 4089.4 4144.3 1542.4 1646.7 1707.1 1732.8 1753.7 333.1 335.3 360.7 682.1 770.9 7781.6 8251.5 8718.2 9624.6 9870.0 322.6 354.4 359.0 371.6 384.6 4694.6 5260.1 5271.2 5283.4 5336.3 442214.0 445751.0 448971.0 453200.7 454385.0 57345.4 58677.4 59380.4 59788.4 60534.4 400.4 405.9 406.0 406.5 407.1 9000.5 9106.3 9169.4 9177.3 9243.7 29273.0 29406.6 29432.1 29676.7 30513.2 36205.8 36528.3 37607.4 37804.2 38356.4 6007.3 6167.8 6170.3 6193.1 6335.9 6969.8 9011.7 9480.2 9509.8 9536.0 8209.7 8326.3 8580.3 8760.6 8765.5 6177.0 8018.0 8304.0 8311.2 8400.1 8354.5 8400.5 8648.6 8844.4 8858.3 5931.0 6284.3 6291.7 6410.5 6616.4 6816.7 8309.7 8323.4 8415.6 8450.7 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#3] mootools.html Cycles:180 Average:4617.33 Median:5941.79 stddev:2349.85 (39.5%) stddev-sans-first:2342.74 15:32:17 INFO - PROCESS | 15571 | Values: 1242.0 1374.5 1374.5 1477.2 1683.6 5664.4 6386.8 6540.6 6553.0 6685.0 6355.6 6494.5 6505.1 6517.9 6556.6 1680.4 1714.7 1716.9 1964.6 1991.5 1738.0 1746.5 1936.8 1969.7 1972.6 1965.8 1966.8 1969.9 1970.7 1971.8 1893.3 1957.7 1959.0 1961.4 1961.8 1921.8 1945.1 1950.2 1952.8 1963.0 6819.8 6900.2 6911.8 6913.2 6930.0 3884.7 3998.3 4000.0 4000.7 4006.5 2468.2 2474.5 2515.7 2530.0 2636.7 829.5 832.8 1684.7 1697.0 1697.5 8607.8 8677.0 8683.7 8729.3 8746.1 3338.3 3383.1 3439.8 3440.8 3441.8 7138.9 7180.6 7187.0 7199.8 7208.1 3912.9 3925.1 3929.6 3937.1 3944.7 3618.2 3628.1 3637.1 3647.4 3669.7 2891.9 2912.8 2949.3 2956.2 2958.7 811.7 831.2 872.5 897.5 909.1 1098.2 1104.0 1104.4 1119.7 1138.3 5943.6 5963.0 5965.9 5975.9 5979.9 928.0 943.5 950.9 951.5 972.5 4966.5 5014.4 5018.2 5018.6 5035.2 7606.1 7812.7 7858.7 8108.0 8187.2 7873.4 8015.9 8027.0 8028.5 8064.0 6250.6 6290.9 6349.5 6382.9 6386.0 5940.0 6060.9 6063.5 6065.1 6070.3 7019.5 7100.5 7167.8 7210.4 7233.0 6957.0 7083.6 7127.9 7159.8 7215.9 5896.8 5999.9 6004.5 6010.1 6016.0 6303.4 6336.1 6353.8 6384.8 6408.0 4977.7 6155.5 6219.2 6282.4 6289.7 5817.4 5832.7 5908.1 5912.6 5963.1 6086.0 6122.5 6124.7 6127.9 6137.8 5457.6 5640.6 5642.3 5643.0 5653.0 5426.9 5464.6 5489.6 5494.8 5497.6 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#4] prototype.html Cycles:180 Average:4551.41 Median:5273.34 stddev:1355.22 (25.7%) stddev-sans-first:1320.44 15:32:17 INFO - PROCESS | 15571 | Values: 273.6 277.6 278.9 280.6 281.3 5050.8 5081.1 5233.3 5291.6 5301.1 5098.9 5258.3 5271.7 5275.0 5275.7 4032.9 4040.1 4040.2 4048.5 4053.3 3799.0 3881.9 4037.6 4040.2 4042.9 3842.5 3843.0 3884.2 3909.0 3994.2 4005.0 4005.6 4009.0 4015.1 4026.3 3488.8 3489.5 3495.8 3495.9 3496.8 5062.8 5075.5 5082.1 5086.4 5087.3 4482.8 4591.8 4593.8 4595.4 4597.6 5489.3 5491.5 5500.8 5503.9 5510.4 3544.6 3614.9 3796.4 3797.2 3800.3 5607.9 5753.7 5777.6 5780.6 5787.1 3916.9 3919.5 3920.1 3921.6 3925.9 3965.0 3970.5 3976.1 3977.7 3979.8 4417.5 4572.3 4583.0 4583.8 4589.4 5484.0 5489.1 5489.9 5491.7 5494.0 1385.1 1403.0 1403.1 1403.7 1405.2 938.9 948.9 949.2 963.5 966.4 4848.3 4851.1 4853.3 4865.1 4865.3 5735.6 5739.8 5743.0 5745.5 5746.4 4786.0 4807.1 4826.3 4829.7 4832.0 2994.1 3047.1 3051.5 3076.1 3078.5 5424.4 5440.6 5443.2 5444.5 5449.0 5818.7 5856.5 5859.2 5860.4 5865.5 5431.7 5433.7 5435.8 5442.9 5444.0 5570.8 5653.2 5692.5 5704.4 5710.3 5367.5 5586.0 5588.6 5593.7 5594.3 5301.2 5362.7 5448.0 5481.6 5491.6 3864.6 3884.7 3888.6 3892.2 3895.3 5712.5 5740.1 5748.9 5757.9 5766.9 5390.5 5522.6 5544.8 5556.6 5563.6 5522.4 5540.3 5548.5 5558.0 5566.7 5419.3 5422.6 5422.8 5432.8 5435.0 5363.2 5591.8 5600.7 5601.2 5606.7 5347.3 5353.3 5356.8 5360.5 5362.5 15:32:17 INFO - PROCESS | 15571 | 15:32:17 INFO - PROCESS | 15571 | [#5] yui.html Cycles:180 Average:11600.48 Median:483.05 stddev:12925.56 (2675.8%) stddev-sans-first:12935.73 15:32:17 INFO - PROCESS | 15571 | Values: 664.4 747.1 760.9 774.9 802.3 11110.7 11224.9 11236.3 11252.7 11283.2 10186.3 10599.4 10970.2 11076.7 11087.3 731.9 747.8 748.4 748.6 748.8 749.4 752.2 752.4 752.4 752.9 778.3 778.9 781.5 782.7 783.4 766.3 769.4 774.3 775.0 779.2 576.7 576.9 576.9 577.3 578.8 9788.2 9874.9 9875.2 9897.9 9899.4 9729.8 9907.8 9989.5 10008.1 10129.6 10532.3 10679.7 10724.1 10872.2 11026.4 3941.4 3950.1 3953.1 3954.6 3955.1 35040.6 35787.4 40507.2 44179.6 44542.8 9487.8 9538.7 9558.5 9562.6 9583.6 15716.4 15719.4 15719.7 15727.2 15754.5 6056.7 6191.9 6314.8 6430.4 6560.5 3608.7 3654.5 3661.7 3685.8 3743.3 2621.0 2625.1 2647.3 2653.9 2655.9 478.3 482.2 482.6 490.0 491.1 483.5 514.7 526.4 526.6 531.4 7007.9 7130.0 7900.2 7964.2 8417.6 450.4 452.1 531.2 531.7 546.7 3359.3 3491.9 3567.7 3585.1 3639.3 43477.1 44064.3 44287.0 44298.1 44311.6 36923.3 38345.2 40501.6 41469.4 41718.8 37234.3 42007.2 42065.4 43458.3 43643.8 7374.6 7694.5 7726.9 7774.1 7782.3 27994.3 29138.0 30355.0 30528.5 30773.4 34961.0 35149.6 35358.3 37256.8 37361.6 9593.3 9612.6 9739.6 9745.8 9889.7 10322.3 10343.5 10398.8 10418.5 10655.0 9823.2 10032.1 10062.6 10077.9 10095.4 10112.0 10129.0 10133.4 10135.7 10154.5 9716.6 9812.6 9822.0 9828.0 9883.5 8131.6 8364.0 8414.0 8421.5 8422.7 8196.4 8562.2 8696.5 8780.4 8797.6 15:32:17 INFO - PROCESS | 15571 | -------- Summary: end -------- 15:32:17 INFO - PROCESS | 15571 | 15:32:18 INFO - TEST-INFO | 15571: exit 0 15:32:18 INFO - TEST-OK | dromaeo_css | took 1116328ms 15:32:18 INFO - TEST-START | kraken 15:32:18 INFO - operating with platform_type : linux_ 15:32:18 INFO - Initialising browser for kraken test... 15:32:18 INFO - TEST-INFO | started process 15772 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCV33C8/profile http://localhost:41498/getInfo.html) 15:32:22 INFO - PROCESS | 15772 | __metrics Screen width/height:1600/1200 15:32:22 INFO - PROCESS | 15772 | colorDepth:24 15:32:22 INFO - PROCESS | 15772 | Browser inner width/height: 1024/697 15:32:22 INFO - PROCESS | 15772 | __metrics 15:32:22 INFO - PROCESS | 15772 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 15:32:22 INFO - PROCESS | 15772 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:32:24 INFO - TEST-INFO | 15772: exit 0 15:32:24 INFO - Browser initialized. 15:32:24 INFO - Running cycle 1/1 for kraken test... 15:32:24 INFO - TEST-INFO | started process 15857 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCV33C8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:32:36 INFO - PROCESS | 15857 | RSS: Main: 151375872 15:32:36 INFO - PROCESS | 15857 | 15:32:38 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41498/tests/kraken/driver.html?testName=audio-beat-detection) 15:32:39 INFO - PROCESS | 15857 | RSS: Main: 188608512 15:32:39 INFO - PROCESS | 15857 | 15:32:42 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41498/tests/kraken/driver.html?testName=audio-dft) 15:32:42 INFO - PROCESS | 15857 | RSS: Main: 179113984 15:32:42 INFO - PROCESS | 15857 | 15:32:45 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41498/tests/kraken/driver.html?testName=audio-fft) 15:32:46 INFO - PROCESS | 15857 | RSS: Main: 163704832 15:32:46 INFO - PROCESS | 15857 | 15:32:48 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41498/tests/kraken/driver.html?testName=audio-oscillator) 15:32:48 INFO - PROCESS | 15857 | RSS: Main: 166219776 15:32:48 INFO - PROCESS | 15857 | 15:32:51 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41498/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:32:51 INFO - PROCESS | 15857 | RSS: Main: 165658624 15:32:51 INFO - PROCESS | 15857 | 15:32:54 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41498/tests/kraken/driver.html?testName=imaging-darkroom) 15:32:55 INFO - PROCESS | 15857 | RSS: Main: 166588416 15:32:55 INFO - PROCESS | 15857 | 15:32:58 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41498/tests/kraken/driver.html?testName=imaging-desaturate) 15:32:59 INFO - PROCESS | 15857 | RSS: Main: 166576128 15:32:59 INFO - PROCESS | 15857 | 15:33:02 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41498/tests/kraken/driver.html?testName=json-parse-financial) 15:33:02 INFO - PROCESS | 15857 | RSS: Main: 165773312 15:33:02 INFO - PROCESS | 15857 | 15:33:04 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41498/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:33:05 INFO - PROCESS | 15857 | RSS: Main: 179113984 15:33:05 INFO - PROCESS | 15857 | 15:33:06 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:33:07 INFO - PROCESS | 15857 | RSS: Main: 176160768 15:33:07 INFO - PROCESS | 15857 | 15:33:09 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:33:10 INFO - PROCESS | 15857 | RSS: Main: 187592704 15:33:10 INFO - PROCESS | 15857 | 15:33:12 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:33:13 INFO - PROCESS | 15857 | RSS: Main: 191827968 15:33:13 INFO - PROCESS | 15857 | 15:33:15 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:33:16 INFO - PROCESS | 15857 | RSS: Main: 189218816 15:33:16 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | Cycle 1(1): loaded http://localhost:41498/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41498/tests/kraken/driver.html?testName=ai-astar) 15:33:18 INFO - PROCESS | 15857 | RSS: Main: 246030336 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | __start_tp_report 15:33:18 INFO - PROCESS | 15857 | _x_x_mozilla_page_load 15:33:18 INFO - PROCESS | 15857 | _x_x_mozilla_page_load_details 15:33:18 INFO - PROCESS | 15857 | |i|pagename|runs| 15:33:18 INFO - PROCESS | 15857 | |0;ai-astar;112;114;110;114;114;115;102;113;112;113 15:33:18 INFO - PROCESS | 15857 | |1;audio-beat-detection;157;131;169;168;135;157;151;134;173;132 15:33:18 INFO - PROCESS | 15857 | |2;audio-dft;163;161;162;163;162;160;163;161;162;162 15:33:18 INFO - PROCESS | 15857 | |3;audio-fft;85;72;98;95;73;73;72;108;87;73 15:33:18 INFO - PROCESS | 15857 | |4;audio-oscillator;98;99;137;97;98;98;137;98;99;132 15:33:18 INFO - PROCESS | 15857 | |5;imaging-gaussian-blur;109;110;109;109;109;110;109;110;109;111 15:33:18 INFO - PROCESS | 15857 | |6;imaging-darkroom;149;148;148;148;149;148;148;149;149;146 15:33:18 INFO - PROCESS | 15857 | |7;imaging-desaturate;96;95;96;95;96;95;96;95;95;95 15:33:18 INFO - PROCESS | 15857 | |8;json-parse-financial;67;68;67;67;66;68;66;76;70;66 15:33:18 INFO - PROCESS | 15857 | |9;json-stringify-tinderbox;68;68;68;69;68;69;68;68;67;69 15:33:18 INFO - PROCESS | 15857 | |10;stanford-crypto-aes;82;84;85;83;94;84;83;83;83;83 15:33:18 INFO - PROCESS | 15857 | |11;stanford-crypto-ccm;120;122;124;127;126;118;131;120;119;126 15:33:18 INFO - PROCESS | 15857 | |12;stanford-crypto-pbkdf2;148;152;147;149;147;137;139;152;147;148 15:33:18 INFO - PROCESS | 15857 | |13;stanford-crypto-sha256-iterative;70;74;70;72;69;70;69;69;71;69 15:33:18 INFO - PROCESS | 15857 | __end_tp_report 15:33:18 INFO - PROCESS | 15857 | __start_cc_report 15:33:18 INFO - PROCESS | 15857 | _x_x_mozilla_cycle_collect,1033 15:33:18 INFO - PROCESS | 15857 | __end_cc_report 15:33:18 INFO - PROCESS | 15857 | __startTimestamp1452987198562__endTimestamp 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | ------- Summary: start ------- 15:33:18 INFO - PROCESS | 15857 | Number of tests: 14 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#0] ai-astar Cycles:10 Average:111.90 Median:113.50 stddev:3.75 (3.3%) stddev-sans-first:3.98 15:33:18 INFO - PROCESS | 15857 | Values: 112.0 114.0 110.0 114.0 114.0 115.0 102.0 113.0 112.0 113.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#1] audio-beat-detection Cycles:10 Average:150.70 Median:157.00 stddev:16.58 (10.6%) stddev-sans-first:17.43 15:33:18 INFO - PROCESS | 15857 | Values: 157.0 131.0 169.0 168.0 135.0 157.0 151.0 134.0 173.0 132.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#2] audio-dft Cycles:10 Average:161.90 Median:162.00 stddev:0.99 (0.6%) stddev-sans-first:0.97 15:33:18 INFO - PROCESS | 15857 | Values: 163.0 161.0 162.0 163.0 162.0 160.0 163.0 161.0 162.0 162.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#3] audio-fft Cycles:10 Average:83.60 Median:79.00 stddev:13.13 (16.6%) stddev-sans-first:13.92 15:33:18 INFO - PROCESS | 15857 | Values: 85.0 72.0 98.0 95.0 73.0 73.0 72.0 108.0 87.0 73.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#4] audio-oscillator Cycles:10 Average:109.30 Median:98.00 stddev:18.02 (18.4%) stddev-sans-first:18.65 15:33:18 INFO - PROCESS | 15857 | Values: 98.0 99.0 137.0 97.0 98.0 98.0 137.0 98.0 99.0 132.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#5] imaging-gaussian-blur Cycles:10 Average:109.50 Median:109.50 stddev:0.71 (0.6%) stddev-sans-first:0.73 15:33:18 INFO - PROCESS | 15857 | Values: 109.0 110.0 109.0 109.0 109.0 110.0 109.0 110.0 109.0 111.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#6] imaging-darkroom Cycles:10 Average:148.20 Median:148.50 stddev:0.92 (0.6%) stddev-sans-first:0.93 15:33:18 INFO - PROCESS | 15857 | Values: 149.0 148.0 148.0 148.0 149.0 148.0 148.0 149.0 149.0 146.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 15:33:18 INFO - PROCESS | 15857 | Values: 96.0 95.0 96.0 95.0 96.0 95.0 96.0 95.0 95.0 95.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#8] json-parse-financial Cycles:10 Average:68.10 Median:67.50 stddev:3.03 (4.5%) stddev-sans-first:3.19 15:33:18 INFO - PROCESS | 15857 | Values: 67.0 68.0 67.0 67.0 66.0 68.0 66.0 76.0 70.0 66.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#9] json-stringify-tinderbox Cycles:10 Average:68.20 Median:68.00 stddev:0.63 (0.9%) stddev-sans-first:0.67 15:33:18 INFO - PROCESS | 15857 | Values: 68.0 68.0 68.0 69.0 68.0 69.0 68.0 68.0 67.0 69.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#10] stanford-crypto-aes Cycles:10 Average:84.40 Median:83.50 stddev:3.47 (4.2%) stddev-sans-first:3.57 15:33:18 INFO - PROCESS | 15857 | Values: 82.0 84.0 85.0 83.0 94.0 84.0 83.0 83.0 83.0 83.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#11] stanford-crypto-ccm Cycles:10 Average:123.30 Median:125.00 stddev:4.19 (3.4%) stddev-sans-first:4.27 15:33:18 INFO - PROCESS | 15857 | Values: 120.0 122.0 124.0 127.0 126.0 118.0 131.0 120.0 119.0 126.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.60 Median:148.00 stddev:4.93 (3.3%) stddev-sans-first:5.20 15:33:18 INFO - PROCESS | 15857 | Values: 148.0 152.0 147.0 149.0 147.0 137.0 139.0 152.0 147.0 148.0 15:33:18 INFO - PROCESS | 15857 | 15:33:18 INFO - PROCESS | 15857 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.30 Median:70.00 stddev:1.64 (2.3%) stddev-sans-first:1.73 15:33:18 INFO - PROCESS | 15857 | Values: 70.0 74.0 70.0 72.0 69.0 70.0 69.0 69.0 71.0 69.0 15:33:18 INFO - PROCESS | 15857 | -------- Summary: end -------- 15:33:18 INFO - PROCESS | 15857 | 15:33:19 INFO - TEST-INFO | 15857: exit 0 15:33:19 INFO - TEST-OK | kraken | took 60986ms 15:33:19 INFO - TEST-START | v8_7 15:33:19 INFO - operating with platform_type : linux_ 15:33:19 INFO - Initialising browser for v8_7 test... 15:33:19 INFO - TEST-INFO | started process 16104 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpNwta5L/profile http://localhost:41498/getInfo.html) 15:33:23 INFO - PROCESS | 16104 | __metrics Screen width/height:1600/1200 15:33:23 INFO - PROCESS | 16104 | colorDepth:24 15:33:23 INFO - PROCESS | 16104 | Browser inner width/height: 1024/697 15:33:23 INFO - PROCESS | 16104 | __metrics 15:33:23 INFO - PROCESS | 16104 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 15:33:23 INFO - PROCESS | 16104 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:33:25 INFO - TEST-INFO | 16104: exit 0 15:33:25 INFO - Browser initialized. 15:33:25 INFO - Running cycle 1/1 for v8_7 test... 15:33:25 INFO - TEST-INFO | started process 16187 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpNwta5L/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:33:37 INFO - PROCESS | 16187 | RSS: Main: 149819392 15:33:37 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | Cycle 1(1): loaded http://localhost:41498/tests/v8_7/run.html (next: http://localhost:41498/tests/v8_7/run.html) 15:33:59 INFO - PROCESS | 16187 | RSS: Main: 450551808 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | __start_tp_report 15:33:59 INFO - PROCESS | 16187 | _x_x_mozilla_page_load 15:33:59 INFO - PROCESS | 16187 | _x_x_mozilla_page_load_details 15:33:59 INFO - PROCESS | 16187 | |i|pagename|runs| 15:33:59 INFO - PROCESS | 16187 | |0;Richards;166.80567139282735 15:33:59 INFO - PROCESS | 16187 | |1;DeltaBlue;187.30099269526127 15:33:59 INFO - PROCESS | 16187 | |2;Encrypt;278.08676307007784 15:33:59 INFO - PROCESS | 16187 | |3;Decrypt;5278.9473684210525 15:33:59 INFO - PROCESS | 16187 | |4;RayTrace;2040.8163265306123 15:33:59 INFO - PROCESS | 16187 | |5;Earley;793.1854199683042 15:33:59 INFO - PROCESS | 16187 | |6;Boyer;12219.512195121952 15:33:59 INFO - PROCESS | 16187 | |7;RegExp;44586.95652173913 15:33:59 INFO - PROCESS | 16187 | |8;Splay;601.4405762304922 15:33:59 INFO - PROCESS | 16187 | |9;NavierStokes;4835.748792270531 15:33:59 INFO - PROCESS | 16187 | __end_tp_report 15:33:59 INFO - PROCESS | 16187 | __startTimestamp1452987239913__endTimestamp 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | ------- Summary: start ------- 15:33:59 INFO - PROCESS | 16187 | Number of tests: 10 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#0] Richards Cycles:1 Average:166.81 Median:166.81 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 166.8 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#1] DeltaBlue Cycles:1 Average:187.30 Median:187.30 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 187.3 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#2] Encrypt Cycles:1 Average:278.09 Median:278.09 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 278.1 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#3] Decrypt Cycles:1 Average:5278.95 Median:5278.95 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 5278.9 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#4] RayTrace Cycles:1 Average:2040.82 Median:2040.82 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 2040.8 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#5] Earley Cycles:1 Average:793.19 Median:793.19 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 793.2 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#6] Boyer Cycles:1 Average:12219.51 Median:12219.51 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 12219.5 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#7] RegExp Cycles:1 Average:44586.96 Median:44586.96 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 44587.0 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#8] Splay Cycles:1 Average:601.44 Median:601.44 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 601.4 15:33:59 INFO - PROCESS | 16187 | 15:33:59 INFO - PROCESS | 16187 | [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 15:33:59 INFO - PROCESS | 16187 | Values: 4835.7 15:33:59 INFO - PROCESS | 16187 | -------- Summary: end -------- 15:33:59 INFO - PROCESS | 16187 | 15:34:00 INFO - TEST-INFO | 16187: exit 0 15:34:00 INFO - TEST-OK | v8_7 | took 41292ms 15:34:00 INFO - SUITE-END | took 1218s 15:34:01 INFO - Completed test suite (00:20:19) 15:34:01 INFO - Working with test: dromaeo_css 15:34:01 INFO - Generating results file: dromaeo_css 15:34:01 INFO - Working with test: kraken 15:34:01 INFO - Generating results file: kraken 15:34:01 INFO - javascript benchmark 15:34:01 INFO - Working with test: v8_7 15:34:01 INFO - Generating results file: v8_7 15:34:01 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:34:01 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 15:34:01 INFO - process_Request line: dromaeo_css 5785.34 graph.html#tests=[[72,132,35]] 15:34:01 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:34:01 INFO - process_Request line: kraken 1531.40 graph.html#tests=[[232,132,35]] 15:34:01 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:34:01 INFO - process_Request line: v8_7 18753.63 graph.html#tests=[[230,132,35]] 15:34:01 INFO - RETURN: dromaeo_css: 5785.34 15:34:01 INFO - RETURN: kraken: 1531.40 15:34:01 INFO - RETURN: v8_7: 18753.63 15:34:01 INFO - javascript benchmark 15:34:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2586.7413258674137, 2609.2433194373634, 2628.158989123481, 2645.3915599412135, 2661.9600705989405, 4275.44419225501, 4367.7160984535985, 4375.7155784874, 4389.880580451984, 4415.271480205766, 4372.8469503567385, 4373.890652733683, 4376.912461750763, 4410.051838854645, 4448.888777780557, 4015.8996025099314, 4018.658414034796, 4052.2705912935658, 4087.4073259377374, 4121.402396652484, 3950.3679411294197, 4013.4581831452674, 4099.815508302118, 4100.302948498747, 4118.6499147572495, 3976.065624578222, 4017.3973903914352, 4030.5364883038533, 4053.1083161704673, 4068.2677118118727, 4030.717849750519, 4058.79706014701, 4079.9592004079877, 4086.2849001424634, 4113.588641135892, 3924.1563063941103, 3994.0, 4024.1549274652066, 4026.295398305285, 4051.0, 4342.283523218665, 4345.1961387143165, 4352.303631418958, 4369.43197384338, 4391.319345501421, 4626.676132670715, 4627.629789616823, 4628.629709623222, 4642.79107440166, 4659.370984917026, 4517.412736344287, 4613.261878099522, 4640.605548528345, 4655.7439340836245, 4700.247960326331, 4303.35449682547, 4341.45731783527, 4392.758398288125, 4419.558044195554, 4437.733735975852, 4778.04439112172, 4808.951910480921, 4810.0, 4810.63920205986, 4853.975730121327, 4496.617787488035, 4569.451665800125, 4614.584687378152, 4623.514530974199, 4627.629789616823, 4608.792604332746, 4665.766711664403, 4699.85900422981, 4718.740469274154, 4765.594924431392, 4613.861584152481, 4624.815007399667, 4629.328747331618, 4632.305154226893, 4665.906681866344, 4495.88760280989, 4583.2666773316105, 4624.28323609841, 4625.722456652612, 4656.557627025427, 3902.863399780994, 3925.2345792570177, 3984.5816189300285, 3999.440078389028, 4021.3766866135797, 3500.212452198235, 3504.3341765064556, 3509.508668786372, 3541.8760343387858, 3551.786892786441, 3980.24375368679, 4048.574899635496, 4050.25070361984, 4066.268071747055, 4100.938485922714, 4626.930596041062, 4630.143423466669, 4657.371254880548, 4692.483826779052, 4697.812087516461, 3953.2093581283857, 4003.5195776507007, 4005.4792876925812, 4015.7188996769946, 4030.6573941215324, 4137.338025915899, 4146.232946904832, 4147.771872547039, 4148.377743338523, 4172.520160181557, 4388.144311859221, 4437.1125774845805, 4472.44094488189, 4475.641948644101, 4508.45898492183, 4597.149527337453, 4615.376924115201, 4620.3993480847275, 4631.51369106239, 4658.37111989877, 4396.1867054595, 4427.601515863587, 4428.269335559726, 4428.446444194476, 4461.330800379969, 4512.5261847505535, 4588.403507544132, 4589.151007063704, 4593.678442509126, 4673.0, 4636.304554316879, 4646.628269738345, 4655.534446555317, 4668.789904454376, 4691.788869500812, 4512.774361281857, 4522.366868638327, 4522.773861306856, 4529.343245229489, 4563.429571303587, 4411.426514553087, 4468.530804265635, 4480.574345437179, 4481.619062379734, 4567.109413664303, 4430.955690443183, 4441.267190913463, 4445.622122119656, 4451.777411129366, 4462.888427789331, 4541.500434952087, 4545.363649089064, 4551.499335073073, 4594.47163576193, 4601.769911504478, 4330.17726631939, 4407.779611019372, 4409.294512877924, 4436.223660859401, 4496.550344965477], "unit": "score", "name": "dojo.html", "value": 4294.080235594121}, {"lowerIsBetter": false, "replicates": [494.8614387971367, 501.50601657367486, 519.2263527344257, 522.2844702757218, 545.5090418623239, 24596.631050534234, 25078.87460562697, 32444.837775811146, 32794.50808237879, 32809.34381312372, 35692.2861542769, 35969.280614387695, 36002.63997360026, 36039.459408108836, 36204.0, 7689.961550192255, 7882.172371900954, 7885.645145968445, 7895.368370530373, 7898.842023159534, 7579.355754760852, 7653.349465295457, 7678.117016543113, 7692.692292308301, 7693.846123077535, 7868.763937081897, 7919.802004949894, 7924.326432253265, 7939.880901786478, 7944.920550794476, 7832.647530861096, 7840.960795196044, 7852.528848269122, 7867.134615192324, 7875.921240787576, 7752.844943101107, 7919.52482851025, 7929.563873986928, 7930.762077137695, 7934.801629959239, 35894.82052589746, 36115.638843611494, 36336.09159771027, 36345.63654363449, 36397.45403818945, 3012.9849350753107, 3022.6221722284713, 3314.648060906039, 3603.621619729917, 3621.4205727083804, 27318.45363092747, 27364.0, 27508.44983100327, 27616.171514854588, 28187.43625127486, 3352.279259959096, 3388.745844061705, 3389.2882494676146, 3400.302937897725, 3439.5872495300723, 155343.0, 155584.22207888888, 156122.0, 156269.0, 156369.99999999886, 46251.5374846254, 47443.5255647446, 52645.7367713159, 53083.73458132685, 53106.73446632742, 40329.39505907414, 58484.70757646269, 59148.40851591429, 59440.0, 59540.0, 12094.455749491293, 12165.148439609142, 12259.816102758467, 12262.448189831479, 12284.815727764091, 9970.102690757722, 10080.647177348757, 10086.142677872316, 10097.192224622013, 10103.797924041479, 15992.0, 16406.0, 18566.628667426576, 19114.904425477784, 19122.139503722366, 6537.542372033912, 6791.388775010174, 6814.705206010842, 6823.624700641413, 6914.481413893978, 774.3959711425098, 797.696875187425, 902.4855832175597, 947.9478628675352, 983.7287293503913, 24197.395065123514, 24204.0, 24235.878820606136, 24252.514949700908, 24253.51492970166, 876.7063033883593, 879.8180512329459, 906.664534122379, 938.441627231796, 942.8067246214509, 13501.324933753272, 13643.317834108453, 13745.931270343584, 14245.216513091673, 14374.0, 207751.0, 210730.0, 211335.0, 211647.0, 211903.0, 43980.0, 44945.55054449479, 44978.775106124915, 45070.32394514085, 45086.0, 1045.320541647935, 1072.8551645528066, 1082.107261509258, 1145.7364806094645, 1152.7809716153904, 25371.0, 26235.0, 27914.860425698553, 28555.42889142247, 28678.56982145311, 39251.803740981115, 39486.80256598699, 39522.64057555025, 39533.0, 39624.207515850096, 197937.02062979763, 220213.0, 224118.0, 225966.0, 234864.0, 24707.752922470547, 24727.62908556409, 24768.76156192147, 24817.875910620332, 25038.248852534452, 33612.495812562345, 35678.4648230282, 37899.0, 38310.0, 38724.2255154901, 29824.36849628603, 32424.0, 32849.50725739163, 33232.501512477815, 33429.83285083559, 30130.84934575313, 30139.547906780976, 31175.532367014966, 31259.0, 31800.0, 28361.14916552507, 28633.42733145367, 28695.13914582566, 28727.281817954718, 28798.7120128796, 26240.475190496465, 27015.324616884736, 28932.0, 29125.271868203465, 29169.270768230963, 22535.774642253367, 22536.715354328822, 22568.758718270652, 22592.5481490366, 22644.433889152904], "unit": "score", "name": "ext.html", "value": 15767.623983681255}, {"lowerIsBetter": false, "replicates": [332.47800952504565, 332.8801631412692, 334.04130146479605, 336.5389416499398, 343.5482340721949, 13957.0, 14445.855541444582, 14878.851211487896, 15528.378864845392, 15539.14534700591, 9122.315826313037, 13589.660258493543, 13655.385507652154, 14048.438062477515, 14216.0, 3420.2304481491715, 4398.164348773731, 4536.455625324966, 4546.431696037996, 4546.704464209833, 3500.632433594474, 4785.808567657307, 4969.4036715594175, 4974.87562810929, 4980.0, 4794.568488836004, 4945.62907781916, 4970.428400733926, 4970.527799859007, 4989.476105008976, 3387.8475468603974, 3489.9127521812156, 4899.240617704261, 4939.67892087015, 4956.900861982776, 4911.386076740408, 4913.238448040559, 4934.185859333205, 4935.6545041847085, 4937.210046392596, 12168.756624867454, 17357.305707771673, 18029.7295540567, 18056.27774889003, 18126.818731812644, 1582.6359937214504, 1588.4916826615488, 1654.5119189839027, 1720.8795384323103, 1738.5219064757166, 7749.0, 7900.762977110696, 7926.564038977912, 8013.51918884863, 10095.444750538718, 1663.6340005198838, 1671.122660603181, 1686.6795308891394, 1701.9404320848712, 1726.8186840381704, 42038.57961420408, 42967.0, 43393.56606433927, 43734.0, 47472.28791568129, 9280.7679808004, 9459.858102128474, 9491.477968711788, 9502.144806967406, 9657.46883921391, 11674.591389301333, 11714.70713232176, 11783.528658853722, 11803.23278986863, 11828.0, 6481.384268494486, 6619.470442364599, 6632.1709786276715, 6678.198616165994, 6732.663366831639, 6195.349488303754, 6211.192544969125, 6243.0, 6364.968175159094, 6380.0, 4020.0954785173103, 4025.879223623296, 4075.7146999709735, 4089.407035979766, 4144.295469770146, 1542.3830467812966, 1646.7118254305449, 1707.1464267866068, 1732.826717328257, 1753.7106377447833, 333.08900158067667, 335.2741315052932, 360.6591770776591, 682.1302838880368, 770.9151993280734, 7781.649825757854, 8251.463654862415, 8718.215360617574, 9624.615015399306, 9869.950650246847, 322.60964233277525, 354.39575523731975, 358.9784612923233, 371.55970175342304, 384.5750445757454, 4694.647901407408, 5260.105782017066, 5271.182966640177, 5283.392409872837, 5336.306280183629, 442214.0, 445751.0, 448971.0, 453200.7339963279, 454385.0, 57345.426545734845, 58677.41322586805, 59380.406195938354, 59788.402115978286, 60534.39465605376, 400.37941191153595, 405.8559211479882, 406.0093372171891, 406.5000049938592, 407.06984540325215, 9000.50497222659, 9106.317026223192, 9169.35814492979, 9177.311701622271, 9243.722688319092, 29272.975445859294, 29406.558901616067, 29432.11703648894, 29676.70323296826, 30513.23716907095, 36205.81897090603, 36528.26943461169, 37607.43588846115, 37804.24391512099, 38356.42465363078, 6007.339192688888, 6167.84580385494, 6170.321264660974, 6193.071039343954, 6335.936640633719, 6969.756058537927, 9011.684591039282, 9480.194183494481, 9509.809803804024, 9536.0, 8209.71266005687, 8326.333893288644, 8580.313574913867, 8760.605772740115, 8765.474071555727, 6176.969115154396, 8018.0, 8303.95848020756, 8311.210435008665, 8400.117987611213, 8354.45696029756, 8400.453970491899, 8648.567571621268, 8844.425112367675, 8858.291336693179, 5930.970345148246, 6284.277308109626, 6291.748330066929, 6410.487161027013, 6616.437602803816, 6816.693248803716, 8309.6676132954, 8323.375746819134, 8415.621297041525, 8450.704225352083], "unit": "score", "name": "jquery.html", "value": 6401.438309318683}, {"lowerIsBetter": false, "replicates": [1241.9751604967907, 1374.4708287309386, 1374.5326588959751, 1477.2392218007728, 1683.5706894741847, 5664.433556644339, 6386.840328991778, 6540.574862633932, 6552.967235163829, 6685.0, 6355.586886852363, 6494.5453818232745, 6505.056766768816, 6517.902231466532, 6556.6066036037755, 1680.4286542575521, 1714.6999275126802, 1716.9055701936388, 1964.6070785842853, 1991.4822146242009, 1738.0006496264634, 1746.4935168801032, 1936.7966363531837, 1969.7242386065961, 1972.5956178983274, 1965.8329042031444, 1966.7934866838991, 1969.901504924748, 1970.7142464342662, 1971.8028197180238, 1893.2521653946683, 1957.716131160988, 1958.9804101958941, 1961.4213806926991, 1961.7842037375876, 1921.769387673474, 1945.1441365799144, 1950.161430584848, 1952.8144826241485, 1962.9988705760022, 6819.795406137824, 6900.2064762551945, 6911.827204319882, 6913.20498142715, 6929.99515070317, 3884.747491413049, 3998.260321840469, 3999.960000399988, 4000.719949603529, 4006.4991876015497, 2468.2101727447225, 2474.4556197636493, 2515.72327044025, 2529.9747002530107, 2636.657234559514, 829.4732844643635, 832.8251067275879, 1684.7304431290934, 1696.9830301696948, 1697.4737831272346, 8607.827843443096, 8677.045524992245, 8683.696070637561, 8729.345299102593, 8746.125387461267, 3338.2655815720505, 3383.120388698907, 3439.7764145330475, 3440.82795860206, 3441.8451169697423, 7138.892916606255, 7180.640967951582, 7187.029750983655, 7199.820004499929, 7208.062951816335, 3912.902177445587, 3925.1168487090176, 3929.5677475478246, 3937.074787424953, 3944.7041471889725, 3618.2401695644207, 3628.0748409155494, 3637.1089083174793, 3647.361711700442, 3669.743117981769, 2891.9421611568073, 2912.7815413844046, 2949.2626843289177, 2956.1870485616196, 2958.7485063769823, 811.6834434570522, 831.1563762780783, 872.4895935877456, 897.537768049455, 909.1408618855119, 1098.181854518389, 1103.9613613523488, 1104.3815463340554, 1119.731264496515, 1138.3113216504062, 5943.613665111754, 5963.0459126539545, 5965.880682386415, 5975.850603734942, 5979.910301345483, 927.9536023198813, 943.4669411782459, 950.8954015058338, 951.4957072751453, 972.4845831709206, 4966.453690094087, 5014.448410674823, 5018.197088465901, 5018.648694591344, 5035.169197082514, 7606.087269527692, 7812.687492500237, 7858.724944627025, 8107.959460202661, 8187.222213889671, 7873.448858579844, 8015.919840801634, 8026.959865200637, 8028.4781489203015, 8064.032316121986, 6250.593711408744, 6290.909991824214, 6349.52378571609, 6382.936170638234, 6385.968070159713, 5939.970300148471, 6060.939390606038, 6063.514918806397, 6065.059915713072, 6070.3019152798, 7019.508634395544, 7100.502964792415, 7167.784966451015, 7210.4231661468, 7233.0, 6957.0, 7083.645817708991, 7127.893081603676, 7159.821004474929, 7215.891761623475, 5896.764129434775, 5999.880002400015, 6004.489618382487, 6010.098485227251, 6015.969920150371, 6303.432691057827, 6336.08126821599, 6353.841153971188, 6384.776532821329, 6408.038794180724, 4977.726225057657, 6155.507559395327, 6219.191505104308, 6282.403171698681, 6289.654069026247, 5817.447342502455, 5832.679202643895, 5908.113782932594, 5912.645241285537, 5963.105534169909, 6086.0, 6122.5408094392205, 6124.724387402489, 6127.938720612737, 6137.815865524041, 5457.645253058538, 5640.605157638925, 5642.2665053544415, 5643.0, 5652.971735141298, 5426.864328391822, 5464.617476776746, 5489.560835133259, 5494.780208791603, 5497.5601951842955], "unit": "score", "name": "mootools.html", "value": 3837.228189080476}, {"lowerIsBetter": false, "replicates": [273.64409351662516, 277.57808131639894, 278.9414223013167, 280.59874379637125, 281.27711780723547, 5050.823221187259, 5081.1108056090125, 5233.293505376773, 5291.603129765269, 5301.125314323137, 5098.923516147261, 5258.2638430619745, 5271.710055946931, 5274.973625131878, 5275.683458992454, 4032.9395059074063, 4040.131371755072, 4040.1919616076757, 4048.4534587830562, 4053.3312003519386, 3798.9810050949704, 3881.8835434936996, 4037.5962403759536, 4040.1717647882115, 4042.898927526806, 3842.4812650292133, 3842.9615703842883, 3884.242572698325, 3908.9609103909024, 3994.2211268802594, 4005.0, 4005.639492445694, 4008.97995510022, 4015.0765323975647, 4026.2752704513177, 3488.843002064888, 3489.5289135966573, 3495.790252584853, 3495.8951231463097, 3496.7552271341015, 5062.797488100471, 5075.543201111917, 5082.059818933509, 5086.364204474441, 5087.338645976037, 4482.820687172509, 4591.770411479412, 4593.816247350102, 4595.379623750784, 4597.563231493003, 5489.286392768954, 5491.533219676332, 5500.80747173847, 5503.889922201573, 5510.448955104497, 3544.5746510418658, 3614.8915532534065, 3796.4115562087923, 3797.1646237827636, 3800.3349413852466, 5607.8878422431735, 5753.7123143843055, 5777.613372790542, 5780.624259423124, 5787.074068149076, 3916.941245881314, 3919.470871432377, 3920.09837737322, 3921.647051765298, 3925.862594809225, 3964.960350396459, 3970.5235371754998, 3976.065624578222, 3977.6817854571564, 3979.840806367713, 4417.491988421309, 4572.268437050123, 4582.95417045832, 4583.770811459413, 4589.426321709786, 5484.012877682056, 5489.149181876815, 5489.945100549024, 5491.670499770026, 5494.0, 1385.1135273425016, 1402.978955315671, 1403.1230480949407, 1403.6561042544643, 1405.1709491399918, 938.9483578403117, 948.9288303377274, 949.2074118111454, 963.4893506441597, 966.4442945306477, 4848.272759086095, 4851.078295123915, 4853.3447984522345, 4865.1485989952325, 4865.294532292798, 5735.627184233012, 5739.827805165852, 5743.0, 5745.540356771448, 5746.396628354046, 4785.95214047862, 4807.086653535817, 4826.348442960226, 4829.710217386968, 4832.0, 2994.1017694691504, 3047.1467988963127, 3051.5117581187346, 3076.077176846937, 3078.5382192671277, 5424.403315635277, 5440.564754819605, 5443.156310771837, 5444.537214336747, 5449.04641687703, 5818.679972601548, 5856.502197313191, 5859.150423188614, 5860.384659610765, 5865.472107510259, 5431.728413579305, 5433.673979561239, 5435.809746658848, 5442.91835622466, 5444.047291723932, 5570.753298731775, 5653.180288858175, 5692.516136128475, 5704.401037890962, 5710.2576665033275, 5367.490088441592, 5586.0, 5588.580856435702, 5593.720313984366, 5594.300712410949, 5301.204819277139, 5362.65142765719, 5448.0, 5481.561475082063, 5491.588130890119, 3864.594217607223, 3884.708646851441, 3888.5722570517787, 3892.163184915257, 3895.3183192941688, 5712.5429965601825, 5740.052891272893, 5748.885022299614, 5757.884842303047, 5766.855828604151, 5390.487903649304, 5522.641028333145, 5544.7782088716, 5556.583256255716, 5563.554915606823, 5522.420145884625, 5540.252065971204, 5548.528375088163, 5558.0, 5566.693831839126, 5419.34967803866, 5422.56302079957, 5422.810201642924, 5432.837014889559, 5435.048866448276, 5363.168708850135, 5591.804286849941, 5600.663960162403, 5601.215829783752, 5606.747696353756, 5347.278117454094, 5353.2505449237915, 5356.812511562077, 5360.490753378423, 5362.51737343641], "unit": "score", "name": "prototype.html", "value": 4109.42951443993}, {"lowerIsBetter": false, "replicates": [664.4285914113863, 747.0885519666006, 760.9277118673725, 774.938004959603, 802.2939812964594, 11110.666679999593, 11224.887751122507, 11236.269642473233, 11252.718682032953, 11283.153763467742, 10186.28695991281, 10599.417032063233, 10970.232083754141, 11076.667699968993, 11087.33475991441, 731.8609464201811, 747.7980945144808, 748.4124961904906, 748.648135376375, 748.8464864702723, 749.35181068376, 752.1613401057808, 752.3567349915825, 752.3717695724077, 752.9397648188132, 778.3384123495013, 778.8831675248701, 781.5467029123123, 782.7377828427456, 783.3576467296818, 766.2682138557664, 769.3575864153438, 774.314731462654, 775.042822114688, 779.2441331908041, 576.6799426318391, 576.8644368573382, 576.890390825746, 577.2899333819383, 578.806099956515, 9788.168005719523, 9874.90125098747, 9875.209983201326, 9897.851532227023, 9899.406035637812, 9729.756756081084, 9907.752306192331, 9989.450580218085, 10008.09927106564, 10129.594816207416, 10532.315399499084, 10679.733006674818, 10724.142068634568, 10872.238943273975, 11026.44867756609, 3941.4284928685465, 3950.071733142709, 3953.1303113315025, 3954.62431069048, 3955.1496428267774, 35040.64959350399, 35787.421257874004, 40507.18985620271, 44179.55820441819, 44542.777286113684, 9487.810243795224, 9538.713838584854, 9558.522073896278, 9562.56968436422, 9583.568739406743, 15716.449924252596, 15719.371225150866, 15719.68560628804, 15727.213639317988, 15754.527364178864, 6056.697165141725, 6191.907121393183, 6314.810555683337, 6430.3891130342545, 6560.540762146699, 3608.693261072838, 3654.488371627974, 3661.7436779425716, 3685.760425572329, 3743.3074881147077, 2620.9868950655123, 2625.133705877056, 2647.2984659065364, 2653.946921061568, 2655.8937642494084, 478.289739736491, 482.151413512214, 482.62355362816356, 489.96570240082855, 491.13069866336383, 483.47228207834087, 514.7477735909378, 526.4051621667568, 526.631358049367, 531.4074806590701, 7007.894881576781, 7130.0, 7900.170482099296, 7964.20357964199, 8417.621207045575, 450.4414525987752, 452.14544510874475, 531.2350215689395, 531.6969327483374, 546.6829239041347, 3359.277755282626, 3491.8952431427097, 3567.7324200684534, 3585.1395665040204, 3639.2721455708966, 43477.13045739131, 44064.339034914505, 44287.0, 44298.11403771971, 44311.55688443139, 36923.26153476969, 38345.233095337935, 40501.594984050374, 41469.37795933063, 41718.79140604338, 37234.25531489355, 42007.15985680269, 42065.369019464124, 43458.34812477815, 43643.78178109089, 7374.594397308199, 7694.499857509244, 7726.9227307726205, 7774.067111946602, 7782.301859281796, 27994.300142496602, 29138.0, 30355.0, 30528.542071869382, 30773.384532309676, 34961.0, 35149.64850351464, 35358.292834143685, 37256.81371593233, 37361.62638373581, 9593.328467007243, 9612.557122988223, 9739.610415583298, 9745.756356091155, 9889.703308900744, 10322.329048611817, 10343.534540945826, 10398.844017339594, 10418.479076046016, 10655.0, 9823.21414286841, 10032.147267482054, 10062.597496100074, 10077.899221007696, 10095.444750538498, 10112.0, 10129.0, 10133.442660653734, 10135.7466063349, 10154.492275386054, 9716.562754675915, 9812.607495700378, 9821.950890245504, 9828.0, 9883.456409897237, 8131.634076466691, 8364.0, 8414.0, 8421.452605580862, 8422.70520531803, 8196.385271104571, 8562.186592273723, 8696.521691307038, 8780.385373023826, 8797.604107815036], "unit": "score", "name": "yui.html", "value": 5485.482168733761}], "name": "dromaeo_css", "value": 5785.337237978601}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 114.0, 110.0, 114.0, 114.0, 115.0, 102.0, 113.0, 112.0, 113.0], "unit": "score", "name": "ai-astar", "value": 111.9}, {"lowerIsBetter": true, "replicates": [157.0, 131.0, 169.0, 168.0, 135.0, 157.0, 151.0, 134.0, 173.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 150.7}, {"lowerIsBetter": true, "replicates": [163.0, 161.0, 162.0, 163.0, 162.0, 160.0, 163.0, 161.0, 162.0, 162.0], "unit": "score", "name": "audio-dft", "value": 161.9}, {"lowerIsBetter": true, "replicates": [85.0, 72.0, 98.0, 95.0, 73.0, 73.0, 72.0, 108.0, 87.0, 73.0], "unit": "score", "name": "audio-fft", "value": 83.6}, {"lowerIsBetter": true, "replicates": [98.0, 99.0, 137.0, 97.0, 98.0, 98.0, 137.0, 98.0, 99.0, 132.0], "unit": "score", "name": "audio-oscillator", "value": 109.3}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 109.0, 109.0, 109.0, 110.0, 109.0, 110.0, 109.0, 111.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.5}, {"lowerIsBetter": true, "replicates": [149.0, 148.0, 148.0, 148.0, 149.0, 148.0, 148.0, 149.0, 149.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 148.2}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 96.0, 95.0, 96.0, 95.0, 96.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 67.0, 67.0, 66.0, 68.0, 66.0, 76.0, 70.0, 66.0], "unit": "score", "name": "json-parse-financial", "value": 68.1}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 68.0, 69.0, 68.0, 69.0, 68.0, 68.0, 67.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.2}, {"lowerIsBetter": true, "replicates": [82.0, 84.0, 85.0, 83.0, 94.0, 84.0, 83.0, 83.0, 83.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.4}, {"lowerIsBetter": true, "replicates": [120.0, 122.0, 124.0, 127.0, 126.0, 118.0, 131.0, 120.0, 119.0, 126.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.3}, {"lowerIsBetter": true, "replicates": [148.0, 152.0, 147.0, 149.0, 147.0, 137.0, 139.0, 152.0, 147.0, 148.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 146.6}, {"lowerIsBetter": true, "replicates": [70.0, 74.0, 70.0, 72.0, 69.0, 70.0, 69.0, 69.0, 71.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.3}], "name": "kraken", "value": 1531.3999999999999}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.80567139282735], "unit": "score", "name": "Richards", "value": 211.6354900000001}, {"lowerIsBetter": false, "replicates": [187.30099269526127], "unit": "score", "name": "DeltaBlue", "value": 353.0040020000002}, {"lowerIsBetter": false, "replicates": [278.08676307007784], "unit": "score", "name": "Encrypt", "value": 957.1868759999999}, {"lowerIsBetter": false, "replicates": [5278.9473684210525], "unit": "score", "name": "Decrypt", "value": 50.423120638085756}, {"lowerIsBetter": false, "replicates": [2040.8163265306123], "unit": "score", "name": "RayTrace", "value": 362.5946099999999}, {"lowerIsBetter": false, "replicates": [793.1854199683042], "unit": "score", "name": "Earley", "value": 840.23606993007}, {"lowerIsBetter": false, "replicates": [12219.512195121952], "unit": "score", "name": "Boyer", "value": 54.540884231536886}, {"lowerIsBetter": false, "replicates": [44586.95652173913], "unit": "score", "name": "RegExp", "value": 20.431647976596796}, {"lowerIsBetter": false, "replicates": [601.4405762304922], "unit": "score", "name": "Splay", "value": 135.49301996007983}, {"lowerIsBetter": false, "replicates": [4835.748792270531], "unit": "score", "name": "NavierStokes", "value": 306.881118881119}], "name": "v8_7", "value": 18753.629783843753}]} 15:34:01 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "18753.63"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1531.40"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "5785.34"}}} 15:34:01 INFO - Return code: 0 15:34:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 15:34:01 INFO - # TBPL SUCCESS # 15:34:01 INFO - Running post-action listener: _resource_record_post_action 15:34:01 INFO - Running post-run listener: _resource_record_post_run 15:34:02 INFO - Total resource usage - Wall time: 1236s; CPU: 13.0%; Read bytes: 0; Write bytes: 411185152; Read time: 0; Write time: 336916 15:34:02 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 106029056; Read time: 0; Write time: 110344 15:34:02 INFO - run-tests - Wall time: 1221s; CPU: 13.0%; Read bytes: 0; Write bytes: 305156096; Read time: 0; Write time: 226572 15:34:02 INFO - Running post-run listener: _upload_blobber_files 15:34:02 INFO - Blob upload gear active. 15:34:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 15:34:02 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 15:34:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 15:34:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 15:34:03 INFO - (blobuploader) - INFO - Open directory for files ... 15:34:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 15:34:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:34:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:34:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 15:34:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:34:04 INFO - (blobuploader) - INFO - Done attempting. 15:34:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 15:34:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:34:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:34:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 15:34:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:34:05 INFO - (blobuploader) - INFO - Done attempting. 15:34:05 INFO - (blobuploader) - INFO - Iteration through files over. 15:34:05 INFO - Return code: 0 15:34:05 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 15:34:05 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 15:34:05 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/81a4f98d3d814f5ac1b0dead6f57196c1fde1134128b3708185cffe26618952063a103610029d39c21696e32771e12b9ab0e42f0ecb5a41f64bb0bf7bb967567", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3c65ab27520224ed4974afdbe1527a7240a1921a01d5421e0bf4ebe97a0248e1b28a004b853221cff1068193168750d00cdc4c88a3e4c5ca358105d225034d73"} 15:34:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 15:34:05 INFO - Writing to file /builds/slave/test/properties/blobber_files 15:34:05 INFO - Contents: 15:34:05 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/81a4f98d3d814f5ac1b0dead6f57196c1fde1134128b3708185cffe26618952063a103610029d39c21696e32771e12b9ab0e42f0ecb5a41f64bb0bf7bb967567", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3c65ab27520224ed4974afdbe1527a7240a1921a01d5421e0bf4ebe97a0248e1b28a004b853221cff1068193168750d00cdc4c88a3e4c5ca358105d225034d73"} 15:34:05 INFO - Running post-run listener: copy_logs_to_upload_dir 15:34:05 INFO - Copying logs to upload dir... 15:34:05 INFO - mkdir: /builds/slave/test/build/upload/logs 15:34:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1311.265894 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 51 secs) (at 2016-01-16 15:34:04.827598) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-16 15:34:04.830972) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/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/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 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-Non-PGO/sha512/81a4f98d3d814f5ac1b0dead6f57196c1fde1134128b3708185cffe26618952063a103610029d39c21696e32771e12b9ab0e42f0ecb5a41f64bb0bf7bb967567", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3c65ab27520224ed4974afdbe1527a7240a1921a01d5421e0bf4ebe97a0248e1b28a004b853221cff1068193168750d00cdc4c88a3e4c5ca358105d225034d73"} build_url:https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011291 build_url: 'https://queue.taskcluster.net/v1/task/BGEWIVpDRXmT4wlvT7omnw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/81a4f98d3d814f5ac1b0dead6f57196c1fde1134128b3708185cffe26618952063a103610029d39c21696e32771e12b9ab0e42f0ecb5a41f64bb0bf7bb967567", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3c65ab27520224ed4974afdbe1527a7240a1921a01d5421e0bf4ebe97a0248e1b28a004b853221cff1068193168750d00cdc4c88a3e4c5ca358105d225034d73"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-16 15:34:04.859356) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:34:04.859962) ========= rm -f oauth.txt in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=14ef55db36f7623abb31b9cf000001d5-1452985664.236206-2028307904 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004463 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-16 15:34:04.945181) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-16 15:34:04.945925) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-16 15:34:04.946527) ========= ========= Total master_lag: 0.30 =========